Task 9182916

Name	07871741_58_0
Workunit	7325993
Created	2 Aug 2020, 8:05:54 UTC
Sent	2 Aug 2020, 12:06:08 UTC
Report deadline	7 Aug 2020, 12:06:08 UTC
Received	7 Aug 2020, 15:29:15 UTC
Server state	Over
Outcome	Computation error
Client state	Compute error
Exit status	197 (0x000000C5) EXIT_TIME_LIMIT_EXCEEDED
Computer ID	6013
Run time	3 hours 46 min 45 sec
CPU time	4 sec
Validate state	Invalid
Credit	0.00
Device peak FLOPS	2.32 GFLOPS
Application version	boinc2docker v1.12 (vbox64_mt) windows_x86_64
Peak working set size	92.46 MB
Peak swap size	96.83 MB
Peak disk usage	230.68 MB
Stderr output

<core_client_version>7.14.2</core_client_version>
<![CDATA[
<message>
exceeded elapsed time limit 13584.24 (86400.00G/6.36G)</message>
<stderr_txt>
2020-08-07 05:46:50 (20436): vboxwrapper (7.9.26200): starting
2020-08-07 05:46:50 (20436): Feature: Checkpoint interval offset (22 seconds)
2020-08-07 05:46:50 (20436): Detected: VirtualBox COM Interface (Version: 5.2.8)
2020-08-07 05:46:50 (20436): Detected: Minimum checkpoint interval (600.000000 seconds)
2020-08-07 05:46:50 (20436): Create VM. (boinc_4cfb04d77571b060, slot#4)
2020-08-07 05:46:50 (20436): Updating drive controller type and model for desired configuration.
2020-08-07 05:46:50 (20436): Setting Memory Size for VM. (3072MB)
2020-08-07 05:46:50 (20436): Setting CPU Count for VM. (1)
2020-08-07 05:46:50 (20436): Setting Chipset Options for VM.
2020-08-07 05:46:50 (20436): Setting Boot Options for VM.
2020-08-07 05:46:50 (20436): Enabling VM Network Access.
2020-08-07 05:46:50 (20436): Setting Network Configuration for NAT.
2020-08-07 05:46:50 (20436): Disabling USB Support for VM.
2020-08-07 05:46:50 (20436): Disabling COM Port Support for VM.
2020-08-07 05:46:50 (20436): Disabling LPT Port Support for VM.
2020-08-07 05:46:50 (20436): Disabling Audio Support for VM.
2020-08-07 05:46:50 (20436): Disabling Clipboard Support for VM.
2020-08-07 05:46:50 (20436): Disabling Drag and Drop Support for VM.
2020-08-07 05:46:50 (20436): Adding storage controller(s) to VM.
2020-08-07 05:46:50 (20436): Adding virtual ISO 9660 disk drive to VM. (vm_isocontext.iso)
2020-08-07 05:46:50 (20436): Adding VirtualBox Guest Additions to VM.
2020-08-07 05:46:50 (20436): Adding network bandwidth throttle group to VM. (Defaulting to 1024GB)
2020-08-07 05:46:50 (20436): Enabling shared directory for VM.
2020-08-07 05:46:50 (20436): Starting VM. (boinc_4cfb04d77571b060, slot#4)
2020-08-07 05:47:00 (20436): Guest Log: BIOS: VirtualBox 5.2.8

2020-08-07 05:47:00 (20436): Guest Log: CPUID EDX: 0x078bf3ff

2020-08-07 05:47:00 (20436): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032

2020-08-07 05:47:00 (20436): Guest Log: int13_harddisk: function 02, unmapped device for ELDL=80

2020-08-07 05:47:00 (20436): Guest Log: BIOS: Boot from Hard Disk 0 failed

2020-08-07 05:47:00 (20436): Guest Log: BIOS: Boot : bseqnr=2, bootseq=0003

2020-08-07 05:47:00 (20436): Guest Log: BIOS: Booting from CD-ROM...

2020-08-07 05:47:00 (20436): Successfully started VM. (PID = '12036')
2020-08-07 05:47:00 (20436): Reporting VM Process ID to BOINC.
2020-08-07 05:47:05 (20436): VM state change detected. (old = 'poweroff', new = 'running')
2020-08-07 05:47:15 (20436): Preference change detected
2020-08-07 05:47:15 (20436): Setting CPU throttle for VM. (75%)
2020-08-07 05:47:15 (20436): Setting checkpoint interval to 600 seconds. (Higher value of (Preference: 60 seconds) or (Vbox_job.xml: 600 seconds))
2020-08-07 05:58:42 (20436): VM state change detected. (old = 'running', new = 'paused')
2020-08-07 05:58:52 (20436): VM state change detected. (old = 'paused', new = 'running')
2020-08-07 06:26:55 (20436): VM state change detected. (old = 'running', new = 'paused')
2020-08-07 06:27:05 (20436): VM state change detected. (old = 'paused', new = 'running')
2020-08-07 06:31:56 (20436): VM state change detected. (old = 'running', new = 'paused')
2020-08-07 06:32:06 (20436): VM state change detected. (old = 'paused', new = 'running')
2020-08-07 06:52:08 (20436): VM state change detected. (old = 'running', new = 'paused')
2020-08-07 06:52:18 (20436): VM state change detected. (old = 'paused', new = 'running')
2020-08-07 07:15:31 (20436): VM state change detected. (old = 'running', new = 'paused')
2020-08-07 07:15:41 (20436): VM state change detected. (old = 'paused', new = 'running')
2020-08-07 07:18:11 (20436): VM state change detected. (old = 'running', new = 'paused')
2020-08-07 07:18:21 (20436): VM state change detected. (old = 'paused', new = 'running')
2020-08-07 07:23:12 (20436): VM state change detected. (old = 'running', new = 'paused')
2020-08-07 07:23:22 (20436): VM state change detected. (old = 'paused', new = 'running')
2020-08-07 07:24:22 (20436): VM state change detected. (old = 'running', new = 'paused')
2020-08-07 07:28:07 (20436): VM state change detected. (old = 'paused', new = 'running')
2020-08-07 07:32:53 (20436): Status Report: Elapsed Time: '6002.009123'
2020-08-07 07:32:53 (20436): Status Report: CPU Time: '4.640625'
2020-08-07 07:42:34 (20436): VM state change detected. (old = 'running', new = 'paused')
2020-08-07 07:42:44 (20436): VM state change detected. (old = 'paused', new = 'running')
2020-08-07 07:43:34 (20436): VM state change detected. (old = 'running', new = 'paused')
2020-08-07 08:48:18 (20436): VM state change detected. (old = 'paused', new = 'running')
2020-08-07 08:50:33 (20436): VM state change detected. (old = 'running', new = 'paused')
2020-08-07 09:01:29 (20436): VM state change detected. (old = 'paused', new = 'running')
2020-08-07 09:01:39 (20436): VM state change detected. (old = 'running', new = 'paused')
2020-08-07 09:04:45 (20436): VM state change detected. (old = 'paused', new = 'running')
2020-08-07 09:10:00 (20436): VM state change detected. (old = 'running', new = 'paused')
2020-08-07 09:13:26 (20436): VM state change detected. (old = 'paused', new = 'running')
2020-08-07 09:17:31 (20436): VM state change detected. (old = 'running', new = 'paused')
2020-08-07 09:22:02 (20436): VM state change detected. (old = 'paused', new = 'running')
2020-08-07 09:38:59 (20436): VM state change detected. (old = 'running', new = 'paused')
2020-08-07 09:43:54 (20436): VM state change detected. (old = 'paused', new = 'running')
2020-08-07 09:47:35 (20436): VM state change detected. (old = 'running', new = 'paused')
2020-08-07 09:50:40 (20436): VM state change detected. (old = 'paused', new = 'running')
2020-08-07 09:58:41 (20436): VM state change detected. (old = 'running', new = 'paused')
2020-08-07 10:01:42 (20436): VM state change detected. (old = 'paused', new = 'running')
2020-08-07 10:42:47 (20436): VM state change detected. (old = 'running', new = 'paused')
2020-08-07 10:45:52 (20436): VM state change detected. (old = 'paused', new = 'running')
2020-08-07 10:47:42 (20436): VM state change detected. (old = 'running', new = 'paused')
2020-08-07 10:52:18 (20436): VM state change detected. (old = 'paused', new = 'running')
2020-08-07 10:59:24 (20436): Status Report: Elapsed Time: '12003.968740'
2020-08-07 10:59:24 (20436): Status Report: CPU Time: '4.765625'
2020-08-07 11:23:42 (20436): Powering off VM.
2020-08-07 11:23:43 (20436): Successfully stopped VM.
2020-08-07 11:23:48 (20436): Deregistering VM. (boinc_4cfb04d77571b060, slot#4)
2020-08-07 11:23:48 (20436): Removing virtual disk drive(s) from VM.
2020-08-07 11:23:48 (20436): Removing network bandwidth throttle group from VM.
2020-08-07 11:23:48 (20436): Removing storage controller(s) from VM.
2020-08-07 11:23:48 (20436): Removing VM from VirtualBox.

    Hypervisor System Log:

27:40:51.232956          Log continuation - Log started 2020-08-06T11:06:25.404409900Z
27:40:57.285471          ERROR [COM]: aRC=E_FAIL (0x80004005) aIID={85cd948e-a71f-4289-281e-0ca7ad48cd89} aComponent={SessionMachine} aText={This machine does not have any snapshots}, preserve=false aResultDetail=0
27:40:57.294259          Saving settings file "C:\ProgramData\BOINC\slots\2\boinc_459c2d9ceddaaab9\boinc_459c2d9ceddaaab9.vbox" with version "1.16-windows"
27:40:57.309884          Saving settings file "C:\ProgramData\BOINC\slots\2\boinc_459c2d9ceddaaab9\boinc_459c2d9ceddaaab9.vbox" with version "1.16-windows"
27:40:57.325508          ERROR [COM]: aRC=VBOX_E_INVALID_OBJECT_STATE (0x80bb0007) aIID={4afe423b-43e0-e9d0-82e8-ceb307940dda} aComponent={MediumWrap} aText={Medium 'C:\Program Files\Oracle\VirtualBox\VBoxGuestAdditions.iso' is locked for reading by another task}, preserve=false aResultDetail=0
27:40:57.327462          Saving settings file "C:\Users\snapp\.VirtualBox\VirtualBox.xml" with version "1.12-windows"
27:40:57.343083          ERROR [COM]: aRC=E_ACCESSDENIED (0x80070005) aIID={4afe423b-43e0-e9d0-82e8-ceb307940dda} aComponent={MediumWrap} aText={The object is not ready}, preserve=false aResultDetail=0
27:40:57.343083          ERROR [COM]: aRC=VBOX_E_INVALID_OBJECT_STATE (0x80bb0007) aIID={4afe423b-43e0-e9d0-82e8-ceb307940dda} aComponent={MediumWrap} aText={Medium 'C:\Program Files\Oracle\VirtualBox\VBoxGuestAdditions.iso' is locked for reading by another task}, preserve=false aResultDetail=0
28:17:14.853464          Saving settings file "C:\ProgramData\BOINC\slots\4\boinc_4cfb04d77571b060\boinc_4cfb04d77571b060.vbox" with version "1.16-windows"
28:17:15.229012          Saving settings file "C:\ProgramData\BOINC\slots\0\boinc_46014f3c548f16d3\boinc_46014f3c548f16d3.vbox" with version "1.16-windows"
28:17:17.073566          Saving settings file "C:\ProgramData\BOINC\slots\5\boinc_4eaa4e7d8b608580\boinc_4eaa4e7d8b608580.vbox" with version "1.16-windows"
28:17:20.900387          ERROR [COM]: aRC=E_FAIL (0x80004005) aIID={85cd948e-a71f-4289-281e-0ca7ad48cd89} aComponent={SessionMachine} aText={This machine does not have any snapshots}, preserve=false aResultDetail=0
28:17:20.905269          Saving settings file "C:\ProgramData\BOINC\slots\4\boinc_4cfb04d77571b060\boinc_4cfb04d77571b060.vbox" with version "1.16-windows"
28:17:20.921870          Saving settings file "C:\ProgramData\BOINC\slots\4\boinc_4cfb04d77571b060\boinc_4cfb04d77571b060.vbox" with version "1.16-windows"
28:17:20.938469          ERROR [COM]: aRC=VBOX_E_INVALID_OBJECT_STATE (0x80bb0007) aIID={4afe423b-43e0-e9d0-82e8-ceb307940dda} aComponent={MediumWrap} aText={Medium 'C:\Program Files\Oracle\VirtualBox\VBoxGuestAdditions.iso' is locked for reading by another task}, preserve=false aResultDetail=0
28:17:20.940423          Saving settings file "C:\Users\snapp\.VirtualBox\VirtualBox.xml" with version "1.12-windows"
28:17:20.955072          ERROR [COM]: aRC=E_ACCESSDENIED (0x80070005) aIID={4afe423b-43e0-e9d0-82e8-ceb307940dda} aComponent={MediumWrap} aText={The object is not ready}, preserve=false aResultDetail=0
28:17:20.956047          ERROR [COM]: aRC=VBOX_E_INVALID_OBJECT_STATE (0x80bb0007) aIID={4afe423b-43e0-e9d0-82e8-ceb307940dda} aComponent={MediumWrap} aText={Medium 'C:\Program Files\Oracle\VirtualBox\VBoxGuestAdditions.iso' is locked for reading by another task}, preserve=false aResultDetail=0
28:17:21.275363          ERROR [COM]: aRC=E_FAIL (0x80004005) aIID={85cd948e-a71f-4289-281e-0ca7ad48cd89} aComponent={SessionMachine} aText={This machine does not have any snapshots}, preserve=false aResultDetail=0
28:17:21.281222          Saving settings file "C:\ProgramData\BOINC\slots\0\boinc_46014f3c548f16d3\boinc_46014f3c548f16d3.vbox" with version "1.16-windows"
28:17:21.296847          Saving settings file "C:\ProgramData\BOINC\slots\0\boinc_46014f3c548f16d3\boinc_46014f3c548f16d3.vbox" with version "1.16-windows"
28:17:21.310528          ERROR [COM]: aRC=VBOX_E_INVALID_OBJECT_STATE (0x80bb0007) aIID={4afe423b-43e0-e9d0-82e8-ceb307940dda} aComponent={MediumWrap} aText={Medium 'C:\Program Files\Oracle\VirtualBox\VBoxGuestAdditions.iso' is locked for reading by another task}, preserve=false aResultDetail=0
28:17:21.313449          Saving settings file "C:\Users\snapp\.VirtualBox\VirtualBox.xml" with version "1.12-windows"
28:17:21.329070          ERROR [COM]: aRC=E_ACCESSDENIED (0x80070005) aIID={4afe423b-43e0-e9d0-82e8-ceb307940dda} aComponent={MediumWrap} aText={The object is not ready}, preserve=false aResultDetail=0
28:17:21.329070          ERROR [COM]: aRC=VBOX_E_INVALID_OBJECT_STATE (0x80bb0007) aIID={4afe423b-43e0-e9d0-82e8-ceb307940dda} aComponent={MediumWrap} aText={Medium 'C:\Program Files\Oracle\VirtualBox\VBoxGuestAdditions.iso' is locked for reading by another task}, preserve=false aResultDetail=0
28:17:23.124098          ERROR [COM]: aRC=E_FAIL (0x80004005) aIID={85cd948e-a71f-4289-281e-0ca7ad48cd89} aComponent={SessionMachine} aText={This machine does not have any snapshots}, preserve=false aResultDetail=0
28:17:23.128979          Saving settings file "C:\ProgramData\BOINC\slots\5\boinc_4eaa4e7d8b608580\boinc_4eaa4e7d8b608580.vbox" with version "1.16-windows"
28:17:23.144605          Saving settings file "C:\ProgramData\BOINC\slots\5\boinc_4eaa4e7d8b608580\boinc_4eaa4e7d8b608580.vbox" with version "1.16-windows"
28:17:23.157299          ERROR [COM]: aRC=VBOX_E_INVALID_OBJECT_STATE (0x80bb0007) aIID={4afe423b-43e0-e9d0-82e8-ceb307940dda} aComponent={MediumWrap} aText={Medium 'C:\Program Files\Oracle\VirtualBox\VBoxGuestAdditions.iso' is locked for reading by another task}, preserve=false aResultDetail=0
28:17:23.159252          Saving settings file "C:\Users\snapp\.VirtualBox\VirtualBox.xml" with version "1.12-windows"
28:17:23.173901          ERROR [COM]: aRC=E_ACCESSDENIED (0x80070005) aIID={4afe423b-43e0-e9d0-82e8-ceb307940dda} aComponent={MediumWrap} aText={The object is not ready}, preserve=false aResultDetail=0
28:17:23.174877          ERROR [COM]: aRC=VBOX_E_INVALID_OBJECT_STATE (0x80bb0007) aIID={4afe423b-43e0-e9d0-82e8-ceb307940dda} aComponent={MediumWrap} aText={Medium 'C:\Program Files\Oracle\VirtualBox\VBoxGuestAdditions.iso' is locked for reading by another task}, preserve=false aResultDetail=0

    VM Execution Log:


    VM Startup Log:


    VM Trace Log:

11:23:58 (20436): called boinc_finish(194)

</stderr_txt>
]]>