Name 9jdNDm3acSvnShfckohDCDFpABFKDmABFKDmuq0ZDmABFKDmDnlGgn_0
Workunit 1937750
Created 12 Sep 2019, 11:37:48 UTC
Sent 12 Sep 2019, 15:41:14 UTC
Report deadline 19 Sep 2019, 15:41:14 UTC
Received 15 Mar 2020, 2:24:12 UTC
Server state Over
Outcome Computation error
Client state Aborted by user
Exit status 203 (0x000000CB) EXIT_ABORTED_VIA_GUI
Computer ID 1599
Run time 10 min 24 sec
CPU time 0 sec
Validate state Invalid
Credit 0.00
Device peak FLOPS 4.48 GFLOPS
Application version ATLAS Simulation v0.84 (vbox64_mt_mcore_atlas)
windows_x86_64
Peak working set size 103.25 MB
Peak swap size 126.88 MB
Peak disk usage 6.91 GB

Stderr output

<core_client_version>7.14.2</core_client_version>
<![CDATA[
<message>
aborted by user</message>
<stderr_txt>
REL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.218400 main     1526: create key '{cbc97ce0-dfae-4c70-a6aa-769e5186363b}' -> 5
00:00:00.218400 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(937) long __cdecl vbpsCreateRegKeyWithDefaultValueAAEx(struct VBPSREGSTATE *,struct HKEY__ *,const char *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.218400 main     1526: create key '{cbc97ce0-dfae-4c70-a6aa-769e5186363b}'(/Default='IMediumAttachment') -> 5
00:00:00.218400 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(842) long __cdecl vbpsCreateRegKeyA(struct VBPSREGSTATE *,struct HKEY__ *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.218400 main     1526: create key '{a0bad6df-d612-47d3-89d4-db3992533948}' -> 5
00:00:00.218400 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(937) long __cdecl vbpsCreateRegKeyWithDefaultValueAAEx(struct VBPSREGSTATE *,struct HKEY__ *,const char *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.218400 main     1526: create key '{a0bad6df-d612-47d3-89d4-db3992533948}'(/Default='IHostPCIDevicePlugEvent') -> 5
00:00:00.218400 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(842) long __cdecl vbpsCreateRegKeyA(struct VBPSREGSTATE *,struct HKEY__ *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.218400 main     1526: create key '{788b87df-7708-444b-9eef-c116ce423d39}' -> 5
00:00:00.218400 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(937) long __cdecl vbpsCreateRegKeyWithDefaultValueAAEx(struct VBPSREGSTATE *,struct HKEY__ *,const char *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.218400 main     1526: create key '{788b87df-7708-444b-9eef-c116ce423d39}'(/Default='IParallelPort') -> 5
00:00:00.218400 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(842) long __cdecl vbpsCreateRegKeyA(struct VBPSREGSTATE *,struct HKEY__ *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.218400 main     1526: create key '{cdbc59df-4f4d-4cf2-809c-917601355afc}' -> 5
00:00:00.218400 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(937) long __cdecl vbpsCreateRegKeyWithDefaultValueAAEx(struct VBPSREGSTATE *,struct HKEY__ *,const char *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.218400 main     1526: create key '{cdbc59df-4f4d-4cf2-809c-917601355afc}'(/Default='IInternalMachineControl') -> 5
00:00:00.218400 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(842) long __cdecl vbpsCreateRegKeyA(struct VBPSREGSTATE *,struct HKEY__ *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.218400 main     1526: create key '{c19073dd-cc7b-431b-98b2-951fda8eab89}' -> 5
00:00:00.218400 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(937) long __cdecl vbpsCreateRegKeyWithDefaultValueAAEx(struct VBPSREGSTATE *,struct HKEY__ *,const char *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.218400 main     1526: create key '{c19073dd-cc7b-431b-98b2-951fda8eab89}'(/Default='IHostUSBDevice') -> 5
00:00:00.218400 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(842) long __cdecl vbpsCreateRegKeyA(struct VBPSREGSTATE *,struct HKEY__ *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.218400 main     1526: create key '{3ba329dc-659c-488b-835c-4eca7ae71c6c}' -> 5
00:00:00.218400 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(937) long __cdecl vbpsCreateRegKeyWithDefaultValueAAEx(struct VBPSREGSTATE *,struct HKEY__ *,const char *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.218400 main     1526: create key '{3ba329dc-659c-488b-835c-4eca7ae71c6c}'(/Default='ISerialPortChangedEvent') -> 5
00:00:00.218400 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(842) long __cdecl vbpsCreateRegKeyA(struct VBPSREGSTATE *,struct HKEY__ *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.218400 main     1526: create key '{ab4164db-c13e-4dab-842d-61ee3f0c1e87}' -> 5
00:00:00.218400 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(937) long __cdecl vbpsCreateRegKeyWithDefaultValueAAEx(struct VBPSREGSTATE *,struct HKEY__ *,const char *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.218400 main     1526: create key '{ab4164db-c13e-4dab-842d-61ee3f0c1e87}'(/Default='IDisplay') -> 5
00:00:00.218400 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(842) long __cdecl vbpsCreateRegKeyA(struct VBPSREGSTATE *,struct HKEY__ *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.218400 main     1526: create key '{431685da-3618-4ebc-b038-833ba829b4b2}' -> 5
00:00:00.218400 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(937) long __cdecl vbpsCreateRegKeyWithDefaultValueAAEx(struct VBPSREGSTATE *,struct HKEY__ *,const char *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.218400 main     1526: create key '{431685da-3618-4ebc-b038-833ba829b4b2}'(/Default='IExtPack') -> 5
00:00:00.218400 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(842) long __cdecl vbpsCreateRegKeyA(struct VBPSREGSTATE *,struct HKEY__ *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.218400 main     1526: create key '{dedfb5d9-4c1b-edf7-fdf3-c1be6827dc28}' -> 5
00:00:00.218400 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(937) long __cdecl vbpsCreateRegKeyWithDefaultValueAAEx(struct VBPSREGSTATE *,struct HKEY__ *,const char *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.218400 main     1526: create key '{dedfb5d9-4c1b-edf7-fdf3-c1be6827dc28}'(/Default='IGuestDnDSource') -> 5
00:00:00.218400 main     AssertLo
[DROP DROP DROP]
00:00:03.851098          ERROR [COM]: aRC=VBOX_E_INVALID_OBJECT_STATE (0x80bb0007) aIID={5047460a-265d-4538-b23e-ddba5fb84976} aComponent={MachineWrap} aText={The given session is busy}, preserve=false aResultDetail=0
00:01:28.498847 dns-monitor HostDnsMonitor::updateInfo
00:01:28.498847 dns-monitor HostDnsMonitor: unchanged

    VM Execution Log:

00:00:00.745047 PIIX3 ATA: Ctl#0: finished processing RESET
00:00:00.745097 PIIX3 ATA: Ctl#1: RESET, DevSel=0 AIOIf=0 CmdIf0=0x00 (-1 usec ago) CmdIf1=0x00 (-1 usec ago)
00:00:00.745121 PIIX3 ATA: Ctl#1: finished processing RESET
00:00:00.747592 PIT: mode=2 count=0x48d3 (18643) - 64.00 Hz (ch=0)
00:00:00.757153 Display::i_handleDisplayResize: uScreenId=0 pvVRAM=000000000be50000 w=640 h=480 bpp=32 cbLine=0xA00 flags=0x0 origin=0,0
00:00:03.238777 Display::i_handleDisplayResize: uScreenId=0 pvVRAM=0000000000000000 w=720 h=400 bpp=0 cbLine=0x0 flags=0x0 origin=0,0
00:00:03.246387 PIT: mode=2 count=0x10000 (65536) - 18.20 Hz (ch=0)
00:00:03.246816 VMMDev: Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032
00:00:03.247336 VMMDev: Guest Log: BIOS: Booting from Hard Disk...
00:00:03.247662 PIIX3 ATA: Ctl#0: RESET, DevSel=0 AIOIf=0 CmdIf0=0xc4 (-1 usec ago) CmdIf1=0x00 (-1 usec ago)
00:00:03.247712 PIIX3 ATA: Ctl#0: finished processing RESET
00:00:05.989012 VMMDev: Guest Log: BIOS: KBD: unsupported int 16h function 03
00:00:05.989205 VMMDev: Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 
00:00:05.989539 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=81
00:00:05.989824 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=81
00:00:05.990099 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=82
00:00:05.990370 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=82
00:00:05.990638 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=83
00:00:05.990910 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=83
00:00:05.991177 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=84
00:00:05.991447 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=84
00:00:05.991714 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=85
00:00:05.992060 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=85
00:00:05.992382 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=86
00:00:05.992636 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=86
00:00:05.992903 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=87
00:00:05.993154 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=87
00:00:05.993421 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=88
00:00:05.993670 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=88
00:00:05.993958 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=89
00:00:05.994208 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=89
00:00:05.994500 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8a
00:00:05.994749 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8a
00:00:05.995037 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8b
00:00:05.995313 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8b
00:00:05.995580 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8c
00:00:05.995851 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8c
00:00:05.996117 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8d
00:00:05.996389 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8d
00:00:05.996656 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8e
00:00:05.996927 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8e
00:00:05.997194 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8f
00:00:05.997465 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8f
00:00:06.187260 GIM: KVM: VCPU  0: Enabled system-time struct. at 0x0000000113b84000 - u32TscScale=0x8e89c884 i8TscShift=-1 uVersion=2 fFlags=0x1 uTsc=0x4901cec73 uVirtNanoTS=0x1453801eb
00:00:06.187320 TM: Switching TSC mode from 'Dynamic' to 'RealTscOffset'
00:00:06.274370 GIM: KVM: Enabled wall-clock struct. at 0x0000000113bd4000 - u32Sec=1577380998 u32Nano=348479334 uVersion=2
00:00:06.300222 PIT: mode=2 count=0x4a9 (1193) - 1000.15 Hz (ch=0)
00:00:06.374804 APIC0: Switched mode to x2APIC
00:00:06.474835 PIT: mode=0 count=0x10000 (65536) - 18.20 Hz (ch=0)
00:00:07.478966 PIIX3 ATA: Ctl#0: RESET, DevSel=0 AIOIf=0 CmdIf0=0xc4 (-1 usec ago) CmdIf1=0x00 (-1 usec ago)
00:00:07.479049 PIIX3 ATA: Ctl#0: finished processing RESET
00:00:07.479325 PIIX3 ATA: Ctl#1: RESET, DevSel=0 AIOIf=0 CmdIf0=0xa1 (-1 usec ago) CmdIf1=0x00 (-1 usec ago)
00:00:07.479384 PIIX3 ATA: Ctl#1: finished processing RESET
00:00:09.259752 VMMDev: Guest Additions information report: Version 5.2.32 r132073 '5.2.32'
00:00:09.259799 VMMDev: Guest Additions information report: Interface = 0x00010004 osType = 0x00053100 (Linux >= 2.6, 64-bit)
00:00:09.259928 VMMDev: Guest Additions capability report: (0x0 -> 0x0) seamless: no, hostWindowMapping: no, graphics: no
00:00:09.260044 VMMDev: Guest reported fixed hypervisor window at 00042000000 LB 0x2400000 (rc=VINF_SUCCESS)
00:00:09.260075 VMMDev: vmmDevReqHandler_HeartbeatConfigure: No change (fHeartbeatActive=false)
00:00:09.260089 VMMDev: Heartbeat flatline timer set to trigger after 4 000 000 000 ns
00:00:09.260115 VMMDev: Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds
00:00:09.261460 VMMDev: Guest Log: vboxguest: misc device minor 58, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000)
00:00:09.444896 Display::i_handleDisplayResize: uScreenId=0 pvVRAM=000000000be50000 w=800 h=600 bpp=32 cbLine=0xC80 flags=0x1 origin=0,0
00:00:09.473751 NAT: Link up
00:00:10.797462 NAT: IPv6 not supported
00:00:10.931783 NAT: DHCP offered IP address 10.0.2.15
00:00:10.933041 NAT: DHCP offered IP address 10.0.2.15
00:00:12.287924 VMMDev: Guest Log: Checking CVMFS...
00:00:17.694597 VMMDev: Guest Log: VBoxService 5.2.32 r132073 (verbosity: 0) linux.amd64 (Jul 12 2019 10:32:28) release log
00:00:17.694619 VMMDev: Guest Log: 00:00:00.000147 main     Log opened 2019-12-26T10:23:28.415625000Z
00:00:17.694667 VMMDev: Guest Log: 00:00:00.000234 main     OS Product: Linux
00:00:17.694698 VMMDev: Guest Log: 00:00:00.000266 main     OS Release: 3.10.0-957.27.2.el7.x86_64
00:00:17.694730 VMMDev: Guest Log: 00:00:00.000299 main     OS Version: #1 SMP Mon Jul 29 17:46:05 UTC 2019
00:00:17.694789 VMMDev: Guest Log: 00:00:00.000357 main     Executable: /opt/VBoxGuestAdditions-5.2.32/sbin/VBoxService
00:00:17.694796 VMMDev: Guest Log: 00:00:00.000358 main     Process ID: 1514
00:00:17.694799 VMMDev: Guest Log: 00:00:00.000358 main     Package type: LINUX_64BITS_GENERIC
00:00:17.697819 VMMDev: Guest Log: 00:00:00.003378 main     5.2.32 r132073 started. Verbose level = 0
00:00:17.703177 Guest Control: GUEST_MSG_REPORT_FEATURES: 0x1, 0x8000000000000000
00:00:17.728643 VMMDev: Guest Log: 00:00:00.034203 automount vbsvcAutoMountWorker: Shared folder 'shared' was mounted to '/media/sf_shared'
00:00:20.186370 VMMDev: Guest Log: CVMFS is ok
00:00:20.349234 VMMDev: Guest Log: Mounting shared directory
00:00:20.449856 VMMDev: Guest Log: Copying input files
00:00:22.453194 VMMDev: Guest Log: Copied input files into RunAtlas.
00:00:23.061737 VMMDev: Guest Log: copied the webapp to /var/www
00:00:23.107354 VMMDev: Guest Log: This vm does not need to setup an http proxy
00:00:23.109764 VMMDev: Guest Log: core_number=1
00:00:23.217138 VMMDev: Guest Log:  *** Starting ATLAS job. (PandaID=4002876565 taskID=000649-2) ***
00:00:27.709642 VMMDev: Guest Log: 00:00:10.014268 timesync vgsvcTimeSyncWorker: Radical guest time change: 25 211 352 861 000ns (GuestNow=1 577 381 019 781 730 000 ns GuestLast=1 577 355 808 428 869 000 ns fSetTimeLastLoop=true )
00:10:07.537891 Display::i_handleDisplayResize: uScreenId=0 pvVRAM=000000000be50000 w=800 h=600 bpp=0 cbLine=0xC80 flags=0x5 origin=0,0

    VM Startup Log:


    VM Trace Log:

2020-03-14 00:16:57 (3912): Detected: vboxwrapper 26202
2020-03-14 00:16:57 (3912): Detected: BOINC client v7.14.2
2020-03-14 00:16:59 (3912): Detected: VirtualBox COM Interface (Version: 6.0.10)
2020-03-14 00:16:59 (3912): Guest Log: BIOS: VirtualBox 6.0.10
2020-03-14 00:16:59 (3912): Guest Log: CPUID EDX: 0x178bfbff
2020-03-14 00:16:59 (3912): Guest Log: BIOS: ata0-0: PCHS=16383/16/63 LCHS=1024/255/63
2020-03-14 00:16:59 (3912): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032
2020-03-14 00:16:59 (3912): Guest Log: BIOS: Booting from Hard Disk...
2020-03-14 00:16:59 (3912): Guest Log: BIOS: KBD: unsupported int 16h function 03
2020-03-14 00:16:59 (3912): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=81
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=81
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=82
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=82
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=83
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=83
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=84
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=84
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=85
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=85
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=86
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=86
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=87
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=87
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=88
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=88
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=89
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=89
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8a
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8a
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8b
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8b
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8c
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8c
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8d
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8d
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8e
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8e
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8f
2020-03-14 00:16:59 (3912): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8f
2020-03-14 00:16:59 (3912): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds
2020-03-14 00:16:59 (3912): Guest Log: vboxguest: misc device minor 58, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000)
2020-03-14 00:16:59 (3912): Guest Log: Checking CVMFS...
2020-03-14 00:16:59 (3912): Guest Log: VBoxService 5.2.32 r132073 (verbosity: 0) linux.amd64 (Jul 12 2019 10:32:28) release log
2020-03-14 00:16:59 (3912): Guest Log: 00:00:00.000147 main     Log opened 2019-12-26T10:23:28.415625000Z
2020-03-14 00:16:59 (3912): Guest Log: 00:00:00.000234 main     OS Product: Linux
2020-03-14 00:16:59 (3912): Guest Log: 00:00:00.000266 main     OS Release: 3.10.0-957.27.2.el7.x86_64
2020-03-14 00:16:59 (3912): Guest Log: 00:00:00.000299 main     OS Version: #1 SMP Mon Jul 29 17:46:05 UTC 2019
2020-03-14 00:16:59 (3912): Guest Log: 00:00:00.000357 main     Executable: /opt/VBoxGuestAdditions-5.2.32/sbin/VBoxService
2020-03-14 00:16:59 (3912): Guest Log: 00:00:00.000358 main     Process ID: 1514
2020-03-14 00:16:59 (3912): Guest Log: 00:00:00.000358 main     Package type: LINUX_64BITS_GENERIC
2020-03-14 00:16:59 (3912): Guest Log: 00:00:00.003378 main     5.2.32 r132073 started. Verbose level = 0
2020-03-14 00:16:59 (3912): Guest Log: 00:00:00.034203 automount vbsvcAutoMountWorker: Shared folder 'shared' was mounted to '/media/sf_shared'
2020-03-14 00:16:59 (3912): Guest Log: CVMFS is ok
2020-03-14 00:16:59 (3912): Guest Log: Mounting shared directory
2020-03-14 00:16:59 (3912): Guest Log: Copying input files
2020-03-14 00:16:59 (3912): Guest Log: Copied input files into RunAtlas.
2020-03-14 00:16:59 (3912): Guest Log: copied the webapp to /var/www
2020-03-14 00:16:59 (3912): Guest Log: This vm does not need to setup an http proxy
2020-03-14 00:16:59 (3912): Guest Log: core_number=1
2020-03-14 00:16:59 (3912): Guest Log:  *** Starting ATLAS job. (PandaID=4002876565 taskID=000649-2) ***
2020-03-14 00:16:59 (3912): Guest Log: 00:00:10.014268 timesync vgsvcTimeSyncWorker: Radical guest time change: 25 211 352 861 000ns (GuestNow=1 577 381 019 781 730 000 ns GuestLast=1 577 355 808 428 869 000 ns fSetTimeLastLoop=true )
2020-03-14 00:16:59 (3912): Starting VM. (boinc_a2b177ae7cb6e411, slot#5)
2020-03-14 00:22:06 (3912): Successfully started VM. (PID = '4188')
2020-03-14 00:22:06 (3912): Reporting VM Process ID to BOINC.
2020-03-14 00:22:06 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:07 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:08 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:09 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:10 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:11 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:12 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:13 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:14 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:15 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:16 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:17 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:18 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:19 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:20 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:21 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:22 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:23 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:24 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:25 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:26 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:27 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:28 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:29 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:30 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:31 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:32 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:33 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:34 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:35 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:36 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:37 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:38 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:39 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:40 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:41 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:42 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:43 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:44 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:45 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:46 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:47 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:48 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:49 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:50 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:51 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:52 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:53 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:54 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:55 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:56 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:57 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:58 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:22:59 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:00 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:01 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:02 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:03 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:04 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:05 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:06 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:07 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:08 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:09 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:10 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:11 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:12 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:13 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:14 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:15 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:16 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:17 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:18 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:19 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:20 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:21 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:22 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:23 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:24 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:25 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:26 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:27 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:28 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:29 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:30 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:31 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:32 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:33 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:34 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:35 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:36 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:37 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:38 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:39 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:40 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:41 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:42 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:43 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:44 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:45 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:46 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:47 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:48 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:49 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:50 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:51 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:52 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:53 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:54 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:55 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:56 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:57 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:58 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:23:59 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:00 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:01 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:02 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:03 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:04 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:05 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:06 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:07 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:08 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:09 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:10 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:11 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:12 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:13 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:14 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:15 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:16 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:17 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:18 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:19 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:20 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:21 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:22 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:23 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:24 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:25 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:26 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:27 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:28 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:29 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:30 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:31 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:32 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:33 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:34 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:35 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:36 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:37 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:38 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:39 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:40 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:41 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:42 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:43 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:44 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:45 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:46 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:47 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:48 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:49 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:50 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:51 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:52 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:53 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:54 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:55 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:56 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:57 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:58 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:24:59 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:00 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:01 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:02 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:03 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:04 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:05 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:06 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:07 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:08 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:09 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:10 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:11 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:12 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:13 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:14 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:15 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:16 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:17 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:18 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:19 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:20 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:21 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:22 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:23 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:24 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:25 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:26 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:27 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:28 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:29 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:30 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:31 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:32 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:33 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:34 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:35 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:36 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:37 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:38 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:39 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:40 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:41 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:42 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:43 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:44 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:45 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:46 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:47 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:48 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:49 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:50 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:51 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:52 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:53 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:54 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:55 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:56 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:57 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:58 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:25:59 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:00 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:01 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:02 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:03 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:04 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:05 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:06 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:07 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:08 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:09 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:10 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:11 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:12 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:13 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:14 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:15 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:16 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:17 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:18 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:19 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:20 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:21 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:22 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:23 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:24 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:25 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:26 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:27 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:28 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:29 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:30 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:31 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:32 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:33 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:34 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:35 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:36 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:37 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:38 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:39 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:40 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:41 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:42 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:43 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:44 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:45 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:46 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:47 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:48 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:49 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:50 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:51 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:52 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:53 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:54 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:55 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:56 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:57 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:58 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:26:59 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:27:00 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:27:01 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:27:02 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:27:03 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:27:04 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:27:05 (3912): VM is no longer is a running state. It is in 'poweredoff'.
2020-03-14 00:27:11 (3912): 
   NOTE: VM failed to enter an online state within the timeout period.
               This might be a temporary problem and so this job will be rescheduled for another time.


    Hypervisor System Log:

00:00:00.171600 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(842) long __cdecl vbpsCreateRegKeyA(struct VBPSREGSTATE *,struct HKEY__ *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.171600 main     1526: create key '{392f1de4-80e1-4a8a-93a1-67c5f92a838a}' -> 5
00:00:00.171600 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(937) long __cdecl vbpsCreateRegKeyWithDefaultValueAAEx(struct VBPSREGSTATE *,struct HKEY__ *,const char *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.171600 main     1526: create key '{392f1de4-80e1-4a8a-93a1-67c5f92a838a}'(/Default='ICertificate') -> 5
00:00:00.171600 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(842) long __cdecl vbpsCreateRegKeyA(struct VBPSREGSTATE *,struct HKEY__ *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.171600 main     1526: create key '{cbc97ce0-dfae-4c70-a6aa-769e5186363b}' -> 5
00:00:00.171600 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(937) long __cdecl vbpsCreateRegKeyWithDefaultValueAAEx(struct VBPSREGSTATE *,struct HKEY__ *,const char *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.171600 main     1526: create key '{cbc97ce0-dfae-4c70-a6aa-769e5186363b}'(/Default='IMediumAttachment') -> 5
00:00:00.171600 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(842) long __cdecl vbpsCreateRegKeyA(struct VBPSREGSTATE *,struct HKEY__ *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.171600 main     1526: create key '{a0bad6df-d612-47d3-89d4-db3992533948}' -> 5
00:00:00.171600 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(937) long __cdecl vbpsCreateRegKeyWithDefaultValueAAEx(struct VBPSREGSTATE *,struct HKEY__ *,const char *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.171600 main     1526: create key '{a0bad6df-d612-47d3-89d4-db3992533948}'(/Default='IHostPCIDevicePlugEvent') -> 5
00:00:00.171600 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(842) long __cdecl vbpsCreateRegKeyA(struct VBPSREGSTATE *,struct HKEY__ *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.171600 main     1526: create key '{788b87df-7708-444b-9eef-c116ce423d39}' -> 5
00:00:00.171600 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(937) long __cdecl vbpsCreateRegKeyWithDefaultValueAAEx(struct VBPSREGSTATE *,struct HKEY__ *,const char *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.171600 main     1526: create key '{788b87df-7708-444b-9eef-c116ce423d39}'(/Default='IParallelPort') -> 5
00:00:00.171600 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(842) long __cdecl vbpsCreateRegKeyA(struct VBPSREGSTATE *,struct HKEY__ *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.171600 main     1526: create key '{cdbc59df-4f4d-4cf2-809c-917601355afc}' -> 5
00:00:00.171600 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(937) long __cdecl vbpsCreateRegKeyWithDefaultValueAAEx(struct VBPSREGSTATE *,struct HKEY__ *,const char *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.171600 main     1526: create key '{cdbc59df-4f4d-4cf2-809c-917601355afc}'(/Default='IInternalMachineControl') -> 5
00:00:00.171600 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(842) long __cdecl vbpsCreateRegKeyA(struct VBPSREGSTATE *,struct HKEY__ *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.171600 main     1526: create key '{c19073dd-cc7b-431b-98b2-951fda8eab89}' -> 5
00:00:00.171600 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(937) long __cdecl vbpsCreateRegKeyWithDefaultValueAAEx(struct VBPSREGSTATE *,struct HKEY__ *,const char *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.171600 main     1526: create key '{c19073dd-cc7b-431b-98b2-951fda8eab89}'(/Default='IHostUSBDevice') -> 5
00:00:00.171600 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(842) long __cdecl vbpsCreateRegKeyA(struct VBPSREGSTATE *,struct HKEY__ *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.171600 main     1526: create key '{3ba329dc-659c-488b-835c-4eca7ae71c6c}' -> 5
00:00:00.171600 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(937) long __cdecl vbpsCreateRegKeyWithDefaultValueAAEx(struct VBPSREGSTATE *,struct HKEY__ *,const char *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.171600 main     1526: create key '{3ba329dc-659c-488b-835c-4eca7ae71c6c}'(/Default='ISerialPortChangedEvent') -> 5
00:00:00.171600 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(842) long __cdecl vbpsCreateRegKeyA(struct VBPSREGSTATE *,struct HKEY__ *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.171600 main     1526: create key '{ab4164db-c13e-4dab-842d-61ee3f0c1e87}' -> 5
00:00:00.171600 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(937) long __cdecl vbpsCreateRegKeyWithDefaultValueAAEx(struct VBPSREGSTATE *,struct HKEY__ *,const char *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.171600 main     1526: create key '{ab4164db-c13e-4dab-842d-61ee3f0c1e87}'(/Default='IDisplay') -> 5
00:00:00.171600 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(842) long __cdecl vbpsCreateRegKeyA(struct VBPSREGSTATE *,struct HKEY__ *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.171600 main     1526: create key '{431685da-3618-4ebc-b038-833ba829b4b2}' -> 5
00:00:00.171600 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(937) long __cdecl vbpsCreateRegKeyWithDefaultValueAAEx(struct VBPSREGSTATE *,struct HKEY__ *,const char *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.171600 main     1526: create key '{431685da-3618-4ebc-b038-833ba829b4b2}'(/Default='IExtPack') -> 5
00:00:00.171600 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(842) long __cdecl vbpsCreateRegKeyA(struct VBPSREGSTATE *,struct HKEY__ *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.171600 main     1526: create key '{dedfb5d9-4c1b-edf7-fdf3-c1be6827dc28}' -> 5
00:00:00.171600 main     AssertLogRel F:\tinderbox\win-6.0\src\VBox\Main\src-all\win\VBoxProxyStub.c(937) long __cdecl vbpsCreateRegKeyWithDefaultValueAAEx(struct VBPSREGSTATE *,struct HKEY__ *,const char *,const char *,struct HKEY__ **,unsigned int): VBPS_LOGREL_NO_ASSERT(rc == ERROR_ACCESS_DENIED)
00:00:00.171600 main     1526: create key '{dedfb5d9-4c1b-edf7-fdf3-c1be6827dc28}'(/Default='IGuestDnDSource') -> 5
00:00:00.171600 main     Asse
[DROP DROP DROP]
00:00:08.703009          ERROR [COM]: aRC=VBOX_E_INVALID_OBJECT_STATE (0x80bb0007) aIID={5047460a-265d-4538-b23e-ddba5fb84976} aComponent={MachineWrap} aText={The given session is busy}, preserve=false aResultDetail=0
00:01:13.541743 USBPROXY Getting USB descriptor (id 1) failed with error 31

    VM Execution Log:

00:00:03.057021 Display::i_handleDisplayResize: uScreenId=0 pvVRAM=000000000bea0000 w=640 h=480 bpp=32 cbLine=0xA00 flags=0x0 origin=0,0
00:00:05.538834 Display::i_handleDisplayResize: uScreenId=0 pvVRAM=0000000000000000 w=720 h=400 bpp=0 cbLine=0x0 flags=0x0 origin=0,0
00:00:05.550606 PIT: mode=2 count=0x10000 (65536) - 18.20 Hz (ch=0)
00:00:05.550967 VMMDev: Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032
00:00:05.568555 VMMDev: Guest Log: BIOS: Booting from Hard Disk...
00:00:05.569161 PIIX3 ATA: Ctl#0: RESET, DevSel=0 AIOIf=0 CmdIf0=0xc4 (-1 usec ago) CmdIf1=0x00 (-1 usec ago)
00:00:05.569161 PIIX3 ATA: Ctl#0: finished processing RESET
00:00:07.945936 VMMDev: Guest Log: BIOS: KBD: unsupported int 16h function 03
00:00:07.946155 VMMDev: Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 
00:00:07.946467 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=81
00:00:07.946752 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=81
00:00:07.947031 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=82
00:00:07.947320 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=82
00:00:07.947616 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=83
00:00:07.947887 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=83
00:00:07.948187 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=84
00:00:07.948448 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=84
00:00:07.948749 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=85
00:00:07.948964 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=85
00:00:07.948964 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=86
00:00:07.948964 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=86
00:00:07.949056 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=87
00:00:07.949317 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=87
00:00:07.949623 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=88
00:00:07.949883 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=88
00:00:07.950184 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=89
00:00:07.950445 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=89
00:00:07.950781 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8a
00:00:07.951126 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8a
00:00:07.951434 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8b
00:00:07.951718 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8b
00:00:07.951997 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8c
00:00:07.952281 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8c
00:00:07.952560 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8d
00:00:07.952848 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8d
00:00:07.953127 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8e
00:00:07.953414 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8e
00:00:07.953693 VMMDev: Guest Log: int13_harddisk_ext: function 41, unmapped device for ELDL=8f
00:00:07.953981 VMMDev: Guest Log: int13_harddisk: function 02, unmapped device for ELDL=8f
00:00:08.126062 GIM: KVM: VCPU  0: Enabled system-time struct. at 0x0000000113b84000 - u32TscScale=0x8e8d1aa4 i8TscShift=-1 uVersion=2 fFlags=0x1 uTsc=0x4432c48e5 uVirtNanoTS=0x12fd0aa29
00:00:08.126094 TM: Switching TSC mode from 'Dynamic' to 'RealTscOffset'
00:00:08.173476 GIM: KVM: Enabled wall-clock struct. at 0x0000000113bd4000 - u32Sec=1584166631 u32Nano=269311429 uVersion=2
00:00:08.193232 PIT: mode=2 count=0x4a9 (1193) - 1000.15 Hz (ch=0)
00:00:08.260505 APIC0: Switched mode to x2APIC
00:00:08.362833 PIT: mode=0 count=0x10000 (65536) - 18.20 Hz (ch=0)
00:00:09.309910 PIIX3 ATA: Ctl#0: RESET, DevSel=0 AIOIf=0 CmdIf0=0xc4 (-1 usec ago) CmdIf1=0x00 (-1 usec ago)
00:00:09.309986 PIIX3 ATA: Ctl#0: finished processing RESET
00:00:09.310291 PIIX3 ATA: Ctl#1: RESET, DevSel=0 AIOIf=0 CmdIf0=0xa1 (-1 usec ago) CmdIf1=0x00 (-1 usec ago)
00:00:09.310355 PIIX3 ATA: Ctl#1: finished processing RESET
00:00:11.305080 NAT: Link up
00:00:13.511686 VMMDev: Guest Additions information report: Version 5.2.32 r132073 '5.2.32'
00:00:13.511737 VMMDev: Guest Additions information report: Interface = 0x00010004 osType = 0x00053100 (Linux >= 2.6, 64-bit)
00:00:13.511935 VMMDev: Guest Additions capability report: (0x0 -> 0x0) seamless: no, hostWindowMapping: no, graphics: no
00:00:13.512172 VMMDev: Guest reported fixed hypervisor window at 00081800000 LB 0x2400000 (rc=VINF_SUCCESS)
00:00:13.512195 VMMDev: vmmDevReqHandler_HeartbeatConfigure: No change (fHeartbeatActive=false)
00:00:13.512210 VMMDev: Heartbeat flatline timer set to trigger after 4 000 000 000 ns
00:00:13.512279 VMMDev: Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds
00:00:13.513523 VMMDev: Guest Log: vboxguest: misc device minor 58, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000)
00:00:13.663165 Display::i_handleDisplayResize: uScreenId=0 pvVRAM=000000000bea0000 w=800 h=600 bpp=32 cbLine=0xC80 flags=0x1 origin=0,0
00:00:16.993517 NAT: IPv6 not supported
00:00:17.259446 NAT: DHCP offered IP address 10.0.2.15
00:00:17.260064 NAT: DHCP offered IP address 10.0.2.15
00:00:18.346057 VMMDev: Guest Log: Checking CVMFS...
00:00:19.421041 VMMDev: Guest Log: Failed to check CVMFS, check output from cvmfs_config probe:
00:00:28.342495 VMMDev: Guest Log: VBoxService 5.2.32 r132073 (verbosity: 0) linux.amd64 (Jul 12 2019 10:32:28) release log
00:00:28.342519 VMMDev: Guest Log: 00:00:00.000127 main     Log opened 2020-03-14T00:17:30.204336000Z
00:00:28.342573 VMMDev: Guest Log: 00:00:00.000214 main     OS Product: Linux
00:00:28.342606 VMMDev: Guest Log: 00:00:00.000247 main     OS Release: 3.10.0-957.27.2.el7.x86_64
00:00:28.342634 VMMDev: Guest Log: 00:00:00.000274 main     OS Version: #1 SMP Mon Jul 29 17:46:05 UTC 2019
00:00:28.342663 VMMDev: Guest Log: 00:00:00.000299 main     Executable: /opt/VBoxGuestAdditions-5.2.32/sbin/VBoxService
00:00:28.342671 VMMDev: Guest Log: 00:00:00.000300 main     Process ID: 1603
00:00:28.342675 VMMDev: Guest Log: 00:00:00.000301 main     Package type: LINUX_64BITS_GENERIC
00:00:28.343662 VMMDev: Guest Log: 00:00:00.001226 main     5.2.32 r132073 started. Verbose level = 0
00:00:28.346656 Guest Control: GUEST_MSG_REPORT_FEATURES: 0x1, 0x8000000000000000
00:00:28.355286 VMMDev: Guest Log: 00:00:00.012724 automount vbsvcAutoMountWorker: Shared folder 'shared' was mounted to '/media/sf_shared'
00:00:31.227678 VMMDev: Guest Log: Probing /cvmfs/atlas.cern.ch... OK
00:00:32.345588 VMMDev: Guest Log: Probing /cvmfs/atlas-condb.cern.ch... OK
00:00:33.865436 VMMDev: Guest Log: Probing /cvmfs/grid.cern.ch... OK
00:00:34.809286 VMMDev: Guest Log: Mounting shared directory
00:00:35.076447 VMMDev: Guest Log: Copying input files
00:00:37.329194 VMMDev: Guest Log: Copied input files into RunAtlas.
00:00:38.096449 VMMDev: Guest Log: copied the webapp to /var/www
00:00:38.141127 VMMDev: Guest Log: This vm does not need to setup an http proxy
00:00:38.143491 VMMDev: Guest Log: core_number=1
00:00:38.314838 VMMDev: Guest Log:  *** Starting ATLAS job. (PandaID=4002876565 taskID=000649-2) ***
00:00:38.347625 VMMDev: Guest Log: 00:00:10.004855 timesync vgsvcTimeSyncWorker: Radical guest time change: 21 611 233 779 000ns (GuestNow=1 584 166 661 442 415 000 ns GuestLast=1 584 145 050 208 636 000 ns fSetTimeLastLoop=true )
00:10:09.388992 Display::i_handleDisplayResize: uScreenId=0 


©2024 CERN