I see that libvirt 1.1.0 should now support virtualbox 4.2, but I'm
having problems getting it to work in OSX.
I have built it using homebrew, which now has 1.1.0 in its formulae.
The error I get when tying to connect is shown below. Any
suggestions for where I should look next?
The error about "Failed to find user record for uid 'NNNNN'" is odd.
libvirtd *is* started automatically, and runs as my own userid
(brian, id 502). Each time libvirtd times out, and restarts again,
it shows a different uid in this error message.
Thanks,
Brian.
Brians-MacBook-Air:~ $ virsh -c vbox:///session list
error: failed to connect to the hypervisor
error: no valid connection
error: Failed to find user record for uid '32691':
Success
Brians-MacBook-Air:~ $ virsh -V
Virsh command line tool of libvirt 1.1.0
See web site at http://libvirt.org/
Compiled with support for:
Hypervisors: VMWare VirtualBox ESX Test
Networking: Remote
Storage: Dir SCSI
Miscellaneous: Daemon Secrets Debug Readline
Modular
Brians-MacBook-Air:~ $ LIBVIRT_DEBUG=1 virsh -c vbox:///session
list
2013-07-14 20:18:52.004+0000: 18446744073709551615:
info : libvirt version: 1.1.0
2013-07-14 20:18:52.004+0000: 18446744073709551615:
debug : virGlobalInit:436 : register drivers
2013-07-14 20:18:52.004+0000: 18446744073709551615:
debug : virRegisterDriver:762 : driver=0x10e39fa58 name=Test
2013-07-14 20:18:52.004+0000: 18446744073709551615:
debug : virRegisterDriver:774 : registering Test as driver 0
2013-07-14 20:18:52.004+0000: 18446744073709551615:
debug : virRegisterNetworkDriver:609 : registering Test as
network driver 0
2013-07-14 20:18:52.004+0000: 18446744073709551615:
debug : virRegisterInterfaceDriver:636 : registering Test as
interface driver 0
2013-07-14 20:18:52.004+0000: 18446744073709551615:
debug : virRegisterStorageDriver:663 : registering Test as
storage driver 0
2013-07-14 20:18:52.004+0000: 18446744073709551615:
debug : virRegisterNodeDeviceDriver:690 : registering Test as
device driver 0
2013-07-14 20:18:52.004+0000: 18446744073709551615:
debug : virRegisterSecretDriver:717 : registering Test as secret
driver 0
2013-07-14 20:18:52.004+0000: 18446744073709551615:
debug : virRegisterNWFilterDriver:744 : registering Test as
network filter driver 0
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virRegisterDriver:762 : driver=0x10e3a10e8 name=VMWARE
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virRegisterDriver:774 : registering VMWARE as driver 1
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virRegisterDriver:762 : driver=0x10e3a16e0 name=ESX
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virRegisterDriver:774 : registering ESX as driver 2
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virRegisterInterfaceDriver:636 : registering ESX as
interface driver 1
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virRegisterNetworkDriver:609 : registering ESX as
network driver 1
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virRegisterStorageDriver:663 : registering ESX as
storage driver 1
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virRegisterNodeDeviceDriver:690 : registering ESX as
device driver 1
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virRegisterSecretDriver:717 : registering ESX as secret
driver 1
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virRegisterNWFilterDriver:744 : registering ESX as
network filter driver 1
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virRegisterDriver:762 : driver=0x10e3a0420 name=remote
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virRegisterDriver:774 : registering remote as driver 3
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virRegisterNetworkDriver:609 : registering remote as
network driver 2
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virRegisterInterfaceDriver:636 : registering remote as
interface driver 2
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virRegisterStorageDriver:663 : registering remote as
storage driver 2
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virRegisterNodeDeviceDriver:690 : registering remote as
device driver 2
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virRegisterSecretDriver:717 : registering remote as
secret driver 2
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virRegisterNWFilterDriver:744 : registering remote as
network filter driver 2
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virEventRegisterDefaultImpl:230 : registering default
event implementation
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virEventPollAddHandle:111 : Used 0 handle slots, adding
at least 10 more
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virEventPollInterruptLocked:712 : Skip interrupt, 0 0
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virEventPollAddHandle:136 : EVENT_POLL_ADD_HANDLE:
watch=1 fd=4 events=1 cb=0x10e1b313f opaque=0x0 ff=0x0
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virEventRegisterImpl:203 : addHandle=0x10e1b1b1b
updateHandle=0x10e1b1df6 removeHandle=0x10e1b1f2d
addTimeout=0x10e1b2064 updateTimeout=0x10e1b2212
removeTimeout=0x10e1b2385
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virEventRunDefaultImpl:270 : running default event
implementation
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virEventPollCleanupTimeouts:516 : Cleanup 0
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virConnectOpenAuth:1446 : name=vbox:///session,
auth=0x10e39f940, flags=0
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virEventPollCleanupTimeouts:552 : Found 0 out of 0
timeout slots used, releasing 0
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virObjectNew:203 : OBJECT_NEW: obj=0x7fa630c45d60
classname=virConnect
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virEventPollCleanupHandles:564 : Cleanup 1
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virObjectNew:203 : OBJECT_NEW: obj=0x7fa630d00050
classname=virConnectCloseCallbackData
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virEventPollMakePollFDs:393 : Prepare n=0 w=1, f=4 e=1
d=0
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virEventPollCalculateTimeout:332 : Calculate expiry of 0
timers
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virEventPollCalculateTimeout:361 : Timeout at 0 due in
-1 ms
2013-07-14 20:18:52.005+0000: 18446744073709551615:
debug : virEventPollRunOnce:629 : EVENT_POLL_RUN: nhandles=1
timeout=-1
2013-07-14 20:18:52.006+0000: 18446744073709551615:
debug : do_open:1158 : name "vbox:///session" to URI components:
scheme vbox
server (null)
user (null)
port 0
path /session
2013-07-14 20:18:52.006+0000: 18446744073709551615: debug :
do_open:1204 : trying driver 0 (Test) ...
2013-07-14 20:18:52.006+0000: 18446744073709551615:
debug : do_open:1211 : driver 0 Test returned DECLINED
2013-07-14 20:18:52.006+0000: 18446744073709551615:
debug : do_open:1204 : trying driver 1 (VMWARE) ...
2013-07-14 20:18:52.006+0000: 18446744073709551615:
debug : do_open:1211 : driver 1 VMWARE returned DECLINED
2013-07-14 20:18:52.006+0000: 18446744073709551615:
debug : do_open:1204 : trying driver 2 (ESX) ...
2013-07-14 20:18:52.006+0000: 18446744073709551615:
debug : do_open:1211 : driver 2 ESX returned DECLINED
2013-07-14 20:18:52.006+0000: 18446744073709551615:
debug : do_open:1204 : trying driver 3 (remote) ...
2013-07-14 20:18:52.006+0000: 18446744073709551615:
debug : remoteConnectOpen:978 : Auto-spawn user daemon instance
2013-07-14 20:18:52.006+0000: 18446744073709551615:
debug : doRemoteOpen:590 : proceeding with name =
vbox:///session
2013-07-14 20:18:52.006+0000: 18446744073709551615:
debug : doRemoteOpen:599 : Connecting with transport 1
2013-07-14 20:18:52.006+0000: 18446744073709551615:
debug : doRemoteOpen:688 : Proceeding with sockname
/Users/brian/.cache/libvirt/libvirt-sock
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virNetSocketNew:155 : localAddr=0x7fff6dd47340
remoteAddr=0x7fff6dd472b0 fd=6 errfd=-1 pid=0
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virObjectNew:203 : OBJECT_NEW: obj=0x7fa630c465d0
classname=virNetSocket
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virNetSocketNew:205 : RPC_SOCKET_NEW:
sock=0x7fa630c465d0 fd=6 errfd=-1 pid=0 localAddr=127.0.0.1;0,
remoteAddr=127.0.0.1;0
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virObjectNew:203 : OBJECT_NEW: obj=0x7fa630c46440
classname=virNetClient
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virNetClientNew:326 : RPC_CLIENT_NEW:
client=0x7fa630c46440 sock=0x7fa630c465d0
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virObjectRef:297 : OBJECT_REF: obj=0x7fa630c46440
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virObjectRef:297 : OBJECT_REF: obj=0x7fa630c465d0
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virEventPollInterruptLocked:716 : Interrupting
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virEventPollAddHandle:136 : EVENT_POLL_ADD_HANDLE:
watch=2 fd=6 events=1 cb=0x10e28e43e opaque=0x7fa630c465d0
ff=0x10e28e489
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virEventPollRunOnce:640 : Poll got 1 event(s)
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virKeepAliveNew:196 : client=0x7fa630c46440,
interval=-1, count=0
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virEventPollDispatchTimeouts:425 : Dispatch 0
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virObjectNew:203 : OBJECT_NEW: obj=0x7fa630d004d0
classname=virKeepAlive
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virEventPollDispatchHandles:470 : Dispatch 1
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virKeepAliveNew:215 : RPC_KEEPALIVE_NEW:
ka=0x7fa630d004d0 client=0x7fa630c46440
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virEventPollDispatchHandles:484 : i=0 w=1
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virObjectRef:297 : OBJECT_REF: obj=0x7fa630c46440
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virEventPollDispatchHandles:498 :
EVENT_POLL_DISPATCH_HANDLE: watch=1 events=1
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virObjectRef:297 : OBJECT_REF: obj=0x7fa630d00050
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virEventPollCleanupTimeouts:516 : Cleanup 0
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virEventPollCleanupTimeouts:552 : Found 0 out of 0
timeout slots used, releasing 0
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virObjectNew:203 : OBJECT_NEW: obj=0x7fa630c467b0
classname=virNetClientProgram
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virEventPollCleanupHandles:564 : Cleanup 2
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virObjectNew:203 : OBJECT_NEW: obj=0x7fa630c46210
classname=virNetClientProgram
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virEventRunDefaultImpl:270 : running default event
implementation
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virObjectNew:203 : OBJECT_NEW: obj=0x7fa630c46240
classname=virNetClientProgram
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virEventPollCleanupTimeouts:516 : Cleanup 0
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virObjectRef:297 : OBJECT_REF: obj=0x7fa630c467b0
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virEventPollCleanupTimeouts:552 : Found 0 out of 0
timeout slots used, releasing 0
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virObjectRef:297 : OBJECT_REF: obj=0x7fa630c46210
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virEventPollCleanupHandles:564 : Cleanup 2
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virObjectRef:297 : OBJECT_REF: obj=0x7fa630c46240
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virEventPollMakePollFDs:393 : Prepare n=0 w=1, f=4 e=1
d=0
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : doRemoteOpen:805 : Trying authentication
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virEventPollMakePollFDs:393 : Prepare n=1 w=2, f=6 e=1
d=0
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virNetMessageNew:46 : msg=0x7fa630d00450 tracked=0
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virEventPollCalculateTimeout:332 : Calculate expiry of 0
timers
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virEventPollCalculateTimeout:361 : Timeout at 0 due in
-1 ms
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virNetMessageEncodePayload:383 : Encode length as 28
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virEventPollRunOnce:629 : EVENT_POLL_RUN: nhandles=2
timeout=-1
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virNetClientSendInternal:1959 : RPC_CLIENT_MSG_TX_QUEUE:
client=0x7fa630c46440 len=28 prog=536903814 vers=1 proc=66
type=0 status=0 serial=0
2013-07-14 20:18:52.007+0000: 18446744073709551615:
debug : virNetClientCallNew:1912 : New call 0x7fa630d00570:
msg=0x7fa630d00450, expectReply=1, nonBlock=0
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virNetClientIO:1719 : Outgoing message prog=536903814
version=1 serial=0 proc=66 type=0 length=28 dispatch=0x0
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virNetClientIO:1778 : We have the buck
head=0x7fa630d00570 call=0x7fa630d00570
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virEventPollUpdateHandle:147 : EVENT_POLL_UPDATE_HANDLE:
watch=2 events=0
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virEventPollInterruptLocked:716 : Interrupting
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virEventPollRunOnce:640 : Poll got 1 event(s)
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virEventPollDispatchTimeouts:425 : Dispatch 0
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virEventPollDispatchHandles:470 : Dispatch 2
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virEventPollDispatchHandles:484 : i=0 w=1
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virEventPollDispatchHandles:498 :
EVENT_POLL_DISPATCH_HANDLE: watch=1 events=1
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virEventPollCleanupTimeouts:516 : Cleanup 0
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virEventPollCleanupTimeouts:552 : Found 0 out of 0
timeout slots used, releasing 0
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virEventPollCleanupHandles:564 : Cleanup 2
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virEventRunDefaultImpl:270 : running default event
implementation
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virEventPollCleanupTimeouts:516 : Cleanup 0
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virEventPollCleanupTimeouts:552 : Found 0 out of 0
timeout slots used, releasing 0
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virEventPollCleanupHandles:564 : Cleanup 2
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virEventPollMakePollFDs:393 : Prepare n=0 w=1, f=4 e=1
d=0
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virEventPollMakePollFDs:393 : Prepare n=1 w=2, f=6 e=0
d=0
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virEventPollCalculateTimeout:332 : Calculate expiry of 0
timers
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virEventPollCalculateTimeout:361 : Timeout at 0 due in
-1 ms
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virEventPollRunOnce:629 : EVENT_POLL_RUN: nhandles=1
timeout=-1
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virNetMessageDecodeLength:153 : Got length, now need 192
total (188 more)
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virNetClientCallDispatch:1126 : RPC_CLIENT_MSG_RX:
client=0x7fa630c46440 len=192 prog=536903814 vers=1 proc=66
type=1 status=1 serial=0
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virKeepAliveCheckMessage:374 : ka=0x7fa630d004d0,
client=0x7fa630c46440, msg=0x7fa630c464c0
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virNetMessageClear:57 : msg=0x7fa630c464c0 nfds=0
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virNetClientIOEventLoopPassTheBuck:1425 : Giving up the
buck 0x7fa630d00570
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virNetClientIOEventLoopPassTheBuck:1439 : No thread to
pass the buck to
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virEventPollUpdateHandle:147 : EVENT_POLL_UPDATE_HANDLE:
watch=2 events=1
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virEventPollInterruptLocked:716 : Interrupting
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virNetClientIO:1808 : All done with our call head=0x0
call=0x7fa630d00570 rv=0
2013-07-14 20:18:52.008+0000: 18446744073709551615:
debug : virEventPollRunOnce:640 : Poll got 1 event(s)
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virEventPollDispatchTimeouts:425 : Dispatch 0
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virNetMessageFree:74 : msg=0x7fa630d00450 nfds=0 cb=0x0
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virEventPollDispatchHandles:470 : Dispatch 1
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virEventPollDispatchHandles:484 : i=0 w=1
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virObjectUnref:260 : OBJECT_UNREF: obj=0x7fa630c467b0
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virEventPollDispatchHandles:498 :
EVENT_POLL_DISPATCH_HANDLE: watch=1 events=1
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virObjectUnref:260 : OBJECT_UNREF: obj=0x7fa630c46210
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virObjectUnref:260 : OBJECT_UNREF: obj=0x7fa630c46240
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virEventPollCleanupTimeouts:516 : Cleanup 0
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virNetClientCloseInternal:686 : client=0x7fa630c46440
wantclose=0
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virEventPollCleanupTimeouts:552 : Found 0 out of 0
timeout slots used, releasing 0
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virNetClientMarkClose:632 : client=0x7fa630c46440,
reason=3
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virEventPollCleanupHandles:564 : Cleanup 2
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virEventPollRemoveHandle:180 : EVENT_POLL_REMOVE_HANDLE:
watch=2
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virEventRunDefaultImpl:270 : running default event
implementation
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virEventPollRemoveHandle:193 : mark delete 1 6
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virEventPollInterruptLocked:712 : Skip interrupt, 0
4537835520
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virNetClientIOEventLoopPassTheBuck:1425 : Giving up the
buck 0x0
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virEventPollCleanupTimeouts:516 : Cleanup 0
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virNetClientIOEventLoopPassTheBuck:1439 : No thread to
pass the buck to
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virEventPollCleanupTimeouts:552 : Found 0 out of 0
timeout slots used, releasing 0
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virNetClientCloseLocked:645 : client=0x7fa630c46440,
sock=0x7fa630c465d0, reason=3
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virEventPollCleanupHandles:564 : Cleanup 2
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virObjectUnref:260 : OBJECT_UNREF: obj=0x7fa630c465d0
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virEventPollCleanupHandles:577 :
EVENT_POLL_PURGE_HANDLE: watch=2
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virObjectRef:297 : OBJECT_REF: obj=0x7fa630c46440
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virObjectUnref:260 : OBJECT_UNREF: obj=0x7fa630c46440
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virKeepAliveStop:307 : RPC_KEEPALIVE_STOP:
ka=0x7fa630d004d0 client=0x7fa630c46440
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virObjectUnref:260 : OBJECT_UNREF: obj=0x7fa630c465d0
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virObjectUnref:260 : OBJECT_UNREF: obj=0x7fa630d004d0
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virObjectUnref:262 : OBJECT_DISPOSE: obj=0x7fa630c465d0
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virObjectUnref:262 : OBJECT_DISPOSE: obj=0x7fa630d004d0
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virNetSocketDispose:1004 : RPC_SOCKET_DISPOSE:
sock=0x7fa630c465d0
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virKeepAliveDispose:227 : RPC_KEEPALIVE_DISPOSE:
ka=0x7fa630d004d0
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virEventPollRemoveHandle:180 : EVENT_POLL_REMOVE_HANDLE:
watch=2
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virObjectUnref:260 : OBJECT_UNREF: obj=0x7fa630c46440
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virObjectUnref:260 : OBJECT_UNREF: obj=0x7fa630c46440
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virObjectUnref:260 : OBJECT_UNREF: obj=0x7fa630c46440
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virObjectUnref:262 : OBJECT_DISPOSE: obj=0x7fa630c46440
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virFileClose:90 : Closed fd 6
2013-07-14 20:18:52.009+0000: 18446744073709551615:
debug : virNetClientDispose:598 : RPC_CLIENT_DISPOSE:
client=0x7fa630c46440
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virEventPollMakePollFDs:393 : Prepare n=0 w=1, f=4 e=1
d=0
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virObjectUnref:260 : OBJECT_UNREF: obj=0x7fa630d00050
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virEventPollCalculateTimeout:332 : Calculate expiry of 0
timers
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virObjectUnref:260 : OBJECT_UNREF: obj=0x7fa630c467b0
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virEventPollCalculateTimeout:361 : Timeout at 0 due in
-1 ms
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virObjectUnref:262 : OBJECT_DISPOSE: obj=0x7fa630c467b0
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virEventPollRunOnce:629 : EVENT_POLL_RUN: nhandles=1
timeout=-1
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virObjectUnref:260 : OBJECT_UNREF: obj=0x7fa630c46210
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virObjectUnref:262 : OBJECT_DISPOSE: obj=0x7fa630c46210
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virObjectUnref:260 : OBJECT_UNREF: obj=0x7fa630c46240
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virObjectUnref:262 : OBJECT_DISPOSE: obj=0x7fa630c46240
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virFileClose:90 : Closed fd 8
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virFileClose:90 : Closed fd 7
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virNetMessageClear:57 : msg=0x7fa630c464c0 nfds=0
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : do_open:1211 : driver 3 remote returned ERROR
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virObjectUnref:260 : OBJECT_UNREF: obj=0x7fa630c45d60
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virObjectUnref:262 : OBJECT_DISPOSE: obj=0x7fa630c45d60
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virObjectUnref:260 : OBJECT_UNREF: obj=0x7fa630d00050
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virObjectUnref:262 : OBJECT_DISPOSE: obj=0x7fa630d00050
error: failed to connect to the hypervisor
error: no valid connection
error: Failed to find user record for uid '32691':
Success
2013-07-14 20:18:52.010+0000: 18446744073709551615: debug :
virEventPollAddTimeout:225 : Used 0 timeout slots, adding at
least 10 more
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virEventPollInterruptLocked:716 : Interrupting
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virEventPollAddTimeout:248 : EVENT_POLL_ADD_TIMEOUT:
timer=1 frequency=0 cb=0x10e14d03f opaque=0x0 ff=0x0
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virEventPollRunOnce:640 : Poll got 1 event(s)
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virEventPollDispatchTimeouts:425 : Dispatch 1
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virEventPollDispatchTimeouts:448 :
EVENT_POLL_DISPATCH_TIMEOUT: timer=1
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virEventPollDispatchHandles:470 : Dispatch 1
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virEventPollDispatchHandles:484 : i=0 w=1
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virEventPollDispatchHandles:498 :
EVENT_POLL_DISPATCH_HANDLE: watch=1 events=1
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virEventPollCleanupTimeouts:516 : Cleanup 1
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virEventPollCleanupHandles:564 : Cleanup 1
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virEventPollRemoveTimeout:300 :
EVENT_POLL_REMOVE_TIMEOUT: timer=1
2013-07-14 20:18:52.010+0000: 18446744073709551615:
debug : virEventPollInterruptLocked:712 : Skip interrupt, 0
4537835520
Brians-MacBook-Air:~ $
Here's the output from the configure step (using brew install
-v)
configure:
configure: Configuration summary
configure: =====================
configure:
configure: Drivers
configure:
configure: Xen: no
configure: QEMU: no
configure: UML: no
configure: OpenVZ: no
configure: VMware: yes
configure: VBox: yes
configure: XenAPI: no
configure: xenlight: no
configure: LXC: no
configure: PHYP: no
configure: ESX: yes
configure: Hyper-V: no
configure: Parallels: no
configure: Test: yes
configure: Remote: yes
configure: Network: no
configure: Libvirtd: yes
configure: Interface: no
configure: macvtap: no
configure: virtport: no
configure:
configure: Storage Drivers
configure:
configure: Dir: yes
configure: FS: no
configure: NetFS: no
configure: LVM: no
configure: iSCSI: no
configure: SCSI: yes
configure: mpath: no
configure: Disk: no
configure: RBD: no
configure: Sheepdog: no
configure:
configure: Security Drivers
configure:
configure: SELinux: no ()
configure: AppArmor: no
configure:
configure: Driver Loadable Modules
configure:
configure: dlopen:
configure:
configure: Libraries
configure:
configure: apparmor: no
configure: attr: no
configure: audit: no
configure: avahi: no
configure: blkid: no
configure: capng: no
configure: curl: yes (CFLAGS='-DCURL_DISABLE_TYPECHECK '
LIBS='-lcurl ')
configure: dbus: no
configure: fuse: no
configure: hal: no
configure: netcf: no
configure: numactl: no
configure: openwsman: no
configure: pciaccess: no
configure: sanlock: no
configure: sasl: yes (CFLAGS='' LIBS='-lsasl2')
configure: selinux: no
configure: ssh2: no
configure: udev: no
configure: yajl: yes (CFLAGS='' LIBS='-lyajl')
configure: libxml: -I/usr/include/libxml2 -lxml2
configure: dlopen:
configure: openwsman: no
configure: gnutls: -I/usr/local/Cellar/libtasn1/3.3/include
-I/usr/local/Cellar/p11-kit/0.18.1/include/p11-kit-1
-I/usr/local/Cellar/gnutls/3.1.10/include
-DGCRYPT_NO_DEPRECATED -L/usr/local/Cellar/gnutls/3.1.10/lib
-lgnutls -lgcrypt
configure: firewalld: no
configure: polkit: no
configure: xen: no
configure: xenapi: no
configure: xenlight: no
configure: pcap: no
configure: nl: no
configure: mscom: no
configure: xdr:
configure: rbd: no
configure:
configure: Test suite
configure:
configure: Coverage: no
configure: Alloc OOM: no
configure:
configure: Miscellaneous
configure:
configure: Debug: yes
configure: Use -Werror: no
configure: Warning Flags: -W -Waddress -Wall -Warray-bounds
-Wattributes -Wbad-function-cast -Wbuiltin-macro-redefined
-Wcast-align -Wchar-subscripts -Wcomment -Wcomments
-Wdeprecated-declarations -Wdisabled-optimization -Wdiv-by-zero
-Wempty-body -Wendif-labels -Wextra -Wformat-extra-args
-Wformat-security -Wformat-y2k -Wformat-zero-length -Wformat=2
-Wignored-qualifiers -Wimplicit -Wimplicit-function-declaration
-Wimplicit-int -Winit-self -Winline -Wint-to-pointer-cast
-Winvalid-pch -Wmain -Wmissing-braces -Wmissing-declarations
-Wmissing-field-initializers -Wmissing-format-attribute
-Wmissing-include-dirs -Wmissing-noreturn -Wmissing-prototypes
-Wmultichar -Wnarrowing -Wnested-externs -Wnonnull
-Wold-style-definition -Woverflow -Wparentheses -Wpointer-arith
-Wpointer-sign -Wpointer-to-int-cast -Wreturn-type
-Wsequence-point -Wshadow -Wsizeof-pointer-memaccess
-Wstrict-aliasing -Wstrict-prototypes -Wswitch -Wtrigraphs
-Wtype-limits -Wuninitialized -Wunknown-pragmas -Wunused
-Wunused-function -Wunused-label -Wunused-parameter
-Wunused-result -Wunused-value -Wunused-variable
-Wvariadic-macros -Wvolatile-register-var -Wwrite-strings
-Wno-missing-field-initializers -Wno-sign-compare
-Wno-format-nonliteral -Wframe-larger-than=4096 -fexceptions
-fasynchronous-unwind-tables -fdiagnostics-show-option
-funit-at-a-time
configure: Readline: yes
configure: Python: yes
configure: DTrace: no
configure: numad: no
configure: XML Catalog: /etc/xml/catalog
configure: Init script: none
configure: Char device locks: no
configure:
configure: Privileges
configure:
configure: QEMU: root:root
configure:
If I run libvirtd by itself manually with the -v flag, this is
all I get:
Brians-MacBook-Air:~ $
/usr/local/Cellar/libvirt/1.1.0/sbin/libvirtd -v
2013-07-14 20:26:14.853+0000: 18446744073709551615: info :
libvirt version: 1.1.0
2013-07-14 20:26:14.853+0000: 18446744073709551615: error :
virGetUserEnt:696 : Failed to find user record for uid '32704':
Success
All entries in /usr/local/etc/libvirt/libvirtd.conf are
commented out.