Task 2825339

Name	Theory_2279-756868-123_2
Workunit	1940686
Created	23 Sep 2019, 19:08:19 UTC
Sent	23 Sep 2019, 19:25:53 UTC
Report deadline	3 Oct 2019, 19:25:53 UTC
Received	28 Sep 2019, 11:09:14 UTC
Server state	Over
Outcome	Computation error
Client state	Compute error
Exit status	1 (0x00000001) Unknown error code
Computer ID	3625
Run time	10 hours 45 min 49 sec
CPU time	32 min 40 sec
Validate state	Invalid
Credit	0.00
Device peak FLOPS	14.88 GFLOPS
Application version	Theory Simulation v5.03 (vbox64_mt_mcore) x86_64-pc-linux-gnu
Peak working set size	573.78 MB
Peak swap size	2.98 GB
Peak disk usage	782.45 MB
Stderr output

<core_client_version>7.14.2</core_client_version>
<![CDATA[
<message>
process exited with code 1 (0x1, -255)</message>
<stderr_txt>
2019-09-23 21:50:58 (28654): vboxwrapper (7.7.26196): starting
2019-09-23 21:50:58 (28654): Feature: Checkpoint interval offset (280 seconds)
2019-09-23 21:50:58 (28654): Detected: VirtualBox VboxManage Interface (Version: 6.0.6)
2019-09-23 21:50:58 (28654): VBOX_JOB::parse(): unexpected text enable_screenshots_on_error/
2019-09-23 21:50:58 (28654): Detected: Minimum checkpoint interval (600.000000 seconds)
2019-09-23 21:50:58 (28654): Detected: Heartbeat check (file: 'heartbeat' every 1200.000000 seconds)
2019-09-23 21:50:58 (28654): Successfully copied 'init_data.xml' to the shared directory.
2019-09-23 21:50:58 (28654): Successfully copied 'input' to the shared directory.
2019-09-23 21:51:00 (28654): Create VM. (boinc_3c0627d4de87bbcb, slot#7)
2019-09-23 21:51:01 (28654): Setting Memory Size for VM. (3750MB)
2019-09-23 21:51:01 (28654): Setting CPU Count for VM. (4)
2019-09-23 21:51:01 (28654): Setting Chipset Options for VM.
2019-09-23 21:51:01 (28654): Setting Boot Options for VM.
2019-09-23 21:51:01 (28654): Setting Network Configuration for NAT.
2019-09-23 21:51:01 (28654): Enabling VM Network Access.
2019-09-23 21:51:02 (28654): Disabling USB Support for VM.
2019-09-23 21:51:02 (28654): Disabling COM Port Support for VM.
2019-09-23 21:51:02 (28654): Disabling LPT Port Support for VM.
2019-09-23 21:51:02 (28654): Disabling Audio Support for VM.
2019-09-23 21:51:02 (28654): Disabling Clipboard Support for VM.
2019-09-23 21:51:02 (28654): Disabling Drag and Drop Support for VM.
2019-09-23 21:51:03 (28654): Adding storage controller(s) to VM.
2019-09-23 21:51:03 (28654): Adding virtual disk drive to VM. (vm_image.vdi)
2019-09-23 21:51:03 (28654): Adding network bandwidth throttle group to VM. (Defaulting to 1024GB)
2019-09-23 21:51:03 (28654): forwarding host port 35569 to guest port 80
2019-09-23 21:51:03 (28654): Enabling remote desktop for VM.
2019-09-23 21:51:03 (28654): Enabling shared directory for VM.
2019-09-23 21:51:04 (28654): Starting VM. (boinc_3c0627d4de87bbcb, slot#7)
2019-09-23 21:51:06 (28654): Successfully started VM. (PID = '29111')
2019-09-23 21:51:06 (28654): Reporting VM Process ID to BOINC.
2019-09-23 21:51:06 (28654): Guest Log: BIOS: VirtualBox 6.0.6
2019-09-23 21:51:06 (28654): Guest Log: CPUID EDX: 0x178bfbff
2019-09-23 21:51:06 (28654): Guest Log: BIOS: ata0-0: PCHS=16383/16/63 LCHS=1024/255/63
2019-09-23 21:51:06 (28654): VM state change detected. (old = 'poweroff', new = 'running')
2019-09-23 21:51:06 (28654): Detected: Web Application Enabled (http://localhost:35569)
2019-09-23 21:51:06 (28654): Detected: Remote Desktop Enabled (localhost:35109)
2019-09-23 21:51:06 (28654): Preference change detected
2019-09-23 21:51:06 (28654): Setting CPU throttle for VM. (100%)
2019-09-23 21:51:08 (28654): Setting checkpoint interval to 600 seconds. (Higher value of (Preference: 120 seconds) or (Vbox_job.xml: 600 seconds))
2019-09-23 21:51:08 (28654): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032
2019-09-23 21:51:08 (28654): Guest Log: BIOS: Booting from Hard Disk...
2019-09-23 21:51:10 (28654): Guest Log: BIOS: KBD: unsupported int 16h function 03
2019-09-23 21:51:10 (28654): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 
2019-09-23 21:51:52 (28654): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds
2019-09-23 21:51:52 (28654): Guest Log: vboxguest: misc device minor 56, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000)
2019-09-23 21:52:02 (28654): Guest Log: VBoxService 5.2.6 r120293 (verbosity: 0) linux.amd64 (Jan 15 2018 14:51:00) release log
2019-09-23 21:52:02 (28654): Guest Log: 00:00:00.075343 main     5.2.6 r120293 started. Verbose level = 0
2019-09-23 23:02:09 (28654): VM state change detected. (old = 'running', new = 'paused')
2019-09-23 23:02:14 (28654): Error in resume VM for VM: -2135228414
Command:
VBoxManage -q controlvm "boinc_3c0627d4de87bbcb" resume
Output:
VBoxManage: error: VM is paused due to host power management
VBoxManage: error: Details: code VBOX_E_INVALID_VM_STATE (0x80bb0002), component ConsoleWrap, interface IConsole, callee nsISupports
VBoxManage: error: Context: "Resume()" at line 409 of file VBoxManageControlVM.cpp

2019-09-24 18:34:47 (28654): Error in resume VM for VM: -2135228414
Command:
VBoxManage -q controlvm "boinc_3c0627d4de87bbcb" resume
Output:
VBoxManage: error: VM is paused due to host power management
VBoxManage: error: Details: code VBOX_E_INVALID_VM_STATE (0x80bb0002), component ConsoleWrap, interface IConsole, callee nsISupports
VBoxManage: error: Context: "Resume()" at line 409 of file VBoxManageControlVM.cpp

2019-09-24 18:34:55 (28654): Error in resume VM for VM: -2135228414
Command:
VBoxManage -q controlvm "boinc_3c0627d4de87bbcb" resume
Output:
VBoxManage: error: Cannot resume the machine as it is not paused (machine state: Running)
VBoxManage: error: Details: code VBOX_E_INVALID_VM_STATE (0x80bb0002), component ConsoleWrap, interface IConsole, callee nsISupports
VBoxManage: error: Context: "Resume()" at line 409 of file VBoxManageControlVM.cpp

2019-09-24 18:34:55 (28654): VM state change detected. (old = 'paused', new = 'running')
2019-09-24 18:34:55 (28654): Guest Log: 01:10:23.159249 timesync vgsvcTimeSyncWorker: Radical host time change: 70 373 934 000 000ns (HostNow=1 569 342 892 225 000 000 ns HostLast=1 569 272 518 291 000 000 ns)
2019-09-24 18:35:02 (28654): Guest Log: 01:10:33.160892 timesync vgsvcTimeSyncWorker: Radical guest time change: 70 358 141 039 000ns (GuestNow=1 569 342 902 229 854 000 ns GuestLast=1 569 272 544 088 815 000 ns fSetTimeLastLoop=true )
2019-09-24 19:02:54 (28654): Status Report: Job Duration: '64800.000000'
2019-09-24 19:02:54 (28654): Status Report: Elapsed Time: '6000.483586'
2019-09-24 19:02:54 (28654): Status Report: CPU Time: '344.850000'
2019-09-24 20:41:55 (28654): Status Report: Job Duration: '64800.000000'
2019-09-24 20:41:55 (28654): Status Report: Elapsed Time: '12000.483586'
2019-09-24 20:41:55 (28654): Status Report: CPU Time: '626.160000'
2019-09-24 22:20:55 (28654): Status Report: Job Duration: '64800.000000'
2019-09-24 22:20:55 (28654): Status Report: Elapsed Time: '18000.498740'
2019-09-24 22:20:55 (28654): Status Report: CPU Time: '864.200000'
2019-09-24 23:24:56 (28654): VM state change detected. (old = 'running', new = 'paused')
2019-09-24 23:25:02 (28654): Error in resume VM for VM: -2135228414
Command:
VBoxManage -q controlvm "boinc_3c0627d4de87bbcb" resume
Output:
VBoxManage: error: VM is paused due to host power management
VBoxManage: error: Details: code VBOX_E_INVALID_VM_STATE (0x80bb0002), component ConsoleWrap, interface IConsole, callee nsISupports
VBoxManage: error: Context: "Resume()" at line 409 of file VBoxManageControlVM.cpp

2019-09-24 23:25:07 (28654): Error in resume VM for VM: -2135228414
Command:
VBoxManage -q controlvm "boinc_3c0627d4de87bbcb" resume
Output:
VBoxManage: error: VM is paused due to host power management
VBoxManage: error: Details: code VBOX_E_INVALID_VM_STATE (0x80bb0002), component ConsoleWrap, interface IConsole, callee nsISupports
VBoxManage: error: Context: "Resume()" at line 409 of file VBoxManageControlVM.cpp

2019-09-24 23:25:13 (28654): Error in resume VM for VM: -2135228414
Command:
VBoxManage -q controlvm "boinc_3c0627d4de87bbcb" resume
Output:
VBoxManage: error: VM is paused due to host power management
VBoxManage: error: Details: code VBOX_E_INVALID_VM_STATE (0x80bb0002), component ConsoleWrap, interface IConsole, callee nsISupports
VBoxManage: error: Context: "Resume()" at line 409 of file VBoxManageControlVM.cpp

2019-09-25 18:31:30 (28654): Error in resume VM for VM: -2135228414
Command:
VBoxManage -q controlvm "boinc_3c0627d4de87bbcb" resume
Output:
VBoxManage: error: VM is paused due to host power management
VBoxManage: error: Details: code VBOX_E_INVALID_VM_STATE (0x80bb0002), component ConsoleWrap, interface IConsole, callee nsISupports
VBoxManage: error: Context: "Resume()" at line 409 of file VBoxManageControlVM.cpp

2019-09-25 18:31:38 (28654): Error in resume VM for VM: -2135228414
Command:
VBoxManage -q controlvm "boinc_3c0627d4de87bbcb" resume
Output:
VBoxManage: error: VM is paused due to host power management
VBoxManage: error: Details: code VBOX_E_INVALID_VM_STATE (0x80bb0002), component ConsoleWrap, interface IConsole, callee nsISupports
VBoxManage: error: Context: "Resume()" at line 409 of file VBoxManageControlVM.cpp

2019-09-25 18:31:41 (28654): VM state change detected. (old = 'paused', new = 'running')
2019-09-25 18:31:42 (28654): VM state change detected. (old = 'running', new = 'paused')
2019-09-25 22:09:39 (28654): VM state change detected. (old = 'paused', new = 'running')
2019-09-25 22:09:44 (28654): Guest Log: 06:01:40.831409 timesync vgsvcTimeSyncWorker: Radical host time change: 81 890 406 000 000ns (HostNow=1 569 442 183 979 000 000 ns HostLast=1 569 360 293 573 000 000 ns)
2019-09-25 22:09:54 (28654): Guest Log: 06:01:50.839539 timesync vgsvcTimeSyncWorker: Radical guest time change: 81 824 087 011 000ns (GuestNow=1 569 442 193 987 295 000 ns GuestLast=1 569 360 369 900 284 000 ns fSetTimeLastLoop=true )
2019-09-25 22:27:39 (28654): VM state change detected. (old = 'running', new = 'paused')
2019-09-25 22:27:46 (28654): Error in resume VM for VM: -2135228414
Command:
VBoxManage -q controlvm "boinc_3c0627d4de87bbcb" resume
Output:
VBoxManage: error: VM is paused due to host power management
VBoxManage: error: Details: code VBOX_E_INVALID_VM_STATE (0x80bb0002), component ConsoleWrap, interface IConsole, callee nsISupports
VBoxManage: error: Context: "Resume()" at line 409 of file VBoxManageControlVM.cpp

2019-09-25 22:27:53 (28654): Error in resume VM for VM: -2135228414
Command:
VBoxManage -q controlvm "boinc_3c0627d4de87bbcb" resume
Output:
VBoxManage: error: VM is paused due to host power management
VBoxManage: error: Details: code VBOX_E_INVALID_VM_STATE (0x80bb0002), component ConsoleWrap, interface IConsole, callee nsISupports
VBoxManage: error: Context: "Resume()" at line 409 of file VBoxManageControlVM.cpp

2019-09-25 22:27:58 (28654): Error in resume VM for VM: -2135228414
Command:
VBoxManage -q controlvm "boinc_3c0627d4de87bbcb" resume
Output:
VBoxManage: error: VM is paused due to host power management
VBoxManage: error: Details: code VBOX_E_INVALID_VM_STATE (0x80bb0002), component ConsoleWrap, interface IConsole, callee nsISupports
VBoxManage: error: Context: "Resume()" at line 409 of file VBoxManageControlVM.cpp

2019-09-25 22:28:04 (28654): Error in resume VM for VM: -2135228414
Command:
VBoxManage -q controlvm "boinc_3c0627d4de87bbcb" resume
Output:
VBoxManage: error: VM is paused due to host power management
VBoxManage: error: Details: code VBOX_E_INVALID_VM_STATE (0x80bb0002), component ConsoleWrap, interface IConsole, callee nsISupports
VBoxManage: error: Context: "Resume()" at line 409 of file VBoxManageControlVM.cpp

2019-09-26 18:23:22 (28654): Error in resume VM for VM: -2135228414
Command:
VBoxManage -q controlvm "boinc_3c0627d4de87bbcb" resume
Output:
VBoxManage: error: VM is paused due to host power management
VBoxManage: error: Details: code VBOX_E_INVALID_VM_STATE (0x80bb0002), component ConsoleWrap, interface IConsole, callee nsISupports
VBoxManage: error: Context: "Resume()" at line 409 of file VBoxManageControlVM.cpp

2019-09-26 18:23:31 (28654): VM state change detected. (old = 'paused', new = 'running')
2019-09-26 18:23:31 (28654): Guest Log: 06:19:42.172587 timesync vgsvcTimeSyncWorker: Radical host time change: 71 759 658 000 000ns (HostNow=1 569 515 010 865 000 000 ns HostLast=1 569 443 251 207 000 000 ns)
2019-09-26 18:23:33 (28654): VM state change detected. (old = 'running', new = 'paused')
2019-09-27 21:37:36 (28654): VM state change detected. (old = 'paused', new = 'running')
2019-09-27 21:37:43 (28654): Guest Log: 06:19:52.180819 timesync vgsvcTimeSyncWorker: Radical host time change: 98 051 941 000 000ns (HostNow=1 569 613 062 806 000 000 ns HostLast=1 569 515 010 865 000 000 ns)
2019-09-27 21:37:43 (28654): Guest Log: 06:19:52.233763 timesync vgsvcTimeSyncWorker: Radical guest time change: 71 755 569 340 000ns (GuestNow=1 569 515 020 880 201 000 ns GuestLast=1 569 443 265 310 861 000 ns fSetTimeLastLoop=true )
2019-09-27 21:37:53 (28654): Guest Log: 06:20:02.234260 timesync vgsvcTimeSyncWorker: Radical guest time change: 98 051 981 706 000ns (GuestNow=1 569 613 072 861 907 000 ns GuestLast=1 569 515 020 880 201 000 ns fSetTimeLastLoop=true )
2019-09-27 21:54:34 (28654): Status Report: Job Duration: '64800.000000'
2019-09-27 21:54:34 (28654): Status Report: Elapsed Time: '24000.819513'
2019-09-27 21:54:34 (28654): Status Report: CPU Time: '1337.550000'
2019-09-27 23:33:42 (28654): Status Report: Job Duration: '64800.000000'
2019-09-27 23:33:42 (28654): Status Report: Elapsed Time: '30001.346086'
2019-09-27 23:33:42 (28654): Status Report: CPU Time: '1535.510000'
2019-09-27 23:35:07 (28654): VM state change detected. (old = 'running', new = 'paused')
2019-09-27 23:35:13 (28654): Error in resume VM for VM: -2135228414
Command:
VBoxManage -q controlvm "boinc_3c0627d4de87bbcb" resume
Output:
VBoxManage: error: VM is paused due to host power management
VBoxManage: error: Details: code VBOX_E_INVALID_VM_STATE (0x80bb0002), component ConsoleWrap, interface IConsole, callee nsISupports
VBoxManage: error: Context: "Resume()" at line 409 of file VBoxManageControlVM.cpp

2019-09-28 10:28:34 (28654): Error in resume VM for VM: -2135228414
Command:
VBoxManage -q controlvm "boinc_3c0627d4de87bbcb" resume
Output:
VBoxManage: error: VM is paused due to host power management
VBoxManage: error: Details: code VBOX_E_INVALID_VM_STATE (0x80bb0002), component ConsoleWrap, interface IConsole, callee nsISupports
VBoxManage: error: Context: "Resume()" at line 409 of file VBoxManageControlVM.cpp

2019-09-28 10:28:36 (28654): VM state change detected. (old = 'paused', new = 'running')
2019-09-28 10:28:41 (28654): Guest Log: 08:17:48.736911 timesync vgsvcTimeSyncWorker: Radical host time change: 39 218 277 000 000ns (HostNow=1 569 659 320 811 000 000 ns HostLast=1 569 620 102 534 000 000 ns)
2019-09-28 10:28:50 (28654): Guest Log: 08:17:58.739665 timesync vgsvcTimeSyncWorker: Radical guest time change: 39 191 453 092 000ns (GuestNow=1 569 659 330 815 711 000 ns GuestLast=1 569 620 139 362 619 000 ns fSetTimeLastLoop=true )
2019-09-28 12:06:12 (28654): Status Report: Job Duration: '64800.000000'
2019-09-28 12:06:12 (28654): Status Report: Elapsed Time: '36001.507483'
2019-09-28 12:06:12 (28654): Status Report: CPU Time: '1758.440000'
2019-09-28 13:03:37 (2279): vboxwrapper (7.7.26196): starting
2019-09-28 13:03:42 (2279): Feature: Checkpoint interval offset (595 seconds)
2019-09-28 13:03:42 (2279): Detected: VirtualBox VboxManage Interface (Version: 6.0.6)
2019-09-28 13:03:42 (2279): VBOX_JOB::parse(): unexpected text enable_screenshots_on_error/
2019-09-28 13:03:42 (2279): Detected: Minimum checkpoint interval (600.000000 seconds)
2019-09-28 13:03:42 (2279): Detected: Heartbeat check (file: 'heartbeat' every 1200.000000 seconds)
2019-09-28 13:03:42 (2279): Guest Log: 06:01:40.831409 timesync vgsvcTimeSyncWorker: Radical host time change: 81 890 406 000 000ns (HostNow=1 569 442 183 979 000 000 ns HostLast=1 569 360 293 573 000 000 ns)
2019-09-28 13:03:42 (2279): Guest Log: 06:01:50.839539 timesync vgsvcTimeSyncWorker: Radical guest time change: 81 824 087 011 000ns (GuestNow=1 569 442 193 987 295 000 ns GuestLast=1 569 360 369 900 284 000 ns fSetTimeLastLoop=true )
2019-09-28 13:03:42 (2279): Guest Log: 06:19:42.172587 timesync vgsvcTimeSyncWorker: Radical host time change: 71 759 658 000 000ns (HostNow=1 569 515 010 865 000 000 ns HostLast=1 569 443 251 207 000 000 ns)
2019-09-28 13:03:42 (2279): Guest Log: 06:19:52.180819 timesync vgsvcTimeSyncWorker: Radical host time change: 98 051 941 000 000ns (HostNow=1 569 613 062 806 000 000 ns HostLast=1 569 515 010 865 000 000 ns)
2019-09-28 13:03:42 (2279): Guest Log: 06:19:52.233763 timesync vgsvcTimeSyncWorker: Radical guest time change: 71 755 569 340 000ns (GuestNow=1 569 515 020 880 201 000 ns GuestLast=1 569 443 265 310 861 000 ns fSetTimeLastLoop=true )
2019-09-28 13:03:42 (2279): Guest Log: 06:20:02.234260 timesync vgsvcTimeSyncWorker: Radical guest time change: 98 051 981 706 000ns (GuestNow=1 569 613 072 861 907 000 ns GuestLast=1 569 515 020 880 201 000 ns fSetTimeLastLoop=true )
2019-09-28 13:03:42 (2279): Guest Log: 08:17:48.736911 timesync vgsvcTimeSyncWorker: Radical host time change: 39 218 277 000 000ns (HostNow=1 569 659 320 811 000 000 ns HostLast=1 569 620 102 534 000 000 ns)
2019-09-28 13:03:42 (2279): Guest Log: 08:17:58.739665 timesync vgsvcTimeSyncWorker: Radical guest time change: 39 191 453 092 000ns (GuestNow=1 569 659 330 815 711 000 ns GuestLast=1 569 620 139 362 619 000 ns fSetTimeLastLoop=true )
2019-09-28 13:03:42 (2279): Starting VM. (boinc_3c0627d4de87bbcb, slot#7)
2019-09-28 13:03:44 (2279): Successfully started VM. (PID = '2403')
2019-09-28 13:03:44 (2279): Reporting VM Process ID to BOINC.
2019-09-28 13:03:44 (2279): VM state change detected. (old = 'poweroff', new = 'running')
2019-09-28 13:03:44 (2279): Detected: Web Application Enabled (http://localhost:35569)
2019-09-28 13:03:44 (2279): Detected: Remote Desktop Enabled (localhost:35109)
2019-09-28 13:03:44 (2279): Status Report: Job Duration: '64800.000000'
2019-09-28 13:03:44 (2279): Status Report: Elapsed Time: '39139.507483'
2019-09-28 13:03:44 (2279): Status Report: CPU Time: '1926.890000'
2019-09-28 13:03:44 (2279): Preference change detected
2019-09-28 13:03:44 (2279): Setting CPU throttle for VM. (100%)
2019-09-28 13:03:44 (2279): Setting checkpoint interval to 600 seconds. (Higher value of (Preference: 120 seconds) or (Vbox_job.xml: 600 seconds))
2019-09-28 13:04:32 (2279): VM Completion File Detected.
2019-09-28 13:04:32 (2279): VM Completion Message: Job Failed
.
2019-09-28 13:04:32 (2279): Powering off VM.
2019-09-28 13:04:32 (2279): Successfully stopped VM.
2019-09-28 13:04:32 (2279): Deregistering VM. (boinc_3c0627d4de87bbcb, slot#7)
2019-09-28 13:04:33 (2279): Removing network bandwidth throttle group from VM.
2019-09-28 13:04:33 (2279): Removing storage controller(s) from VM.
2019-09-28 13:04:33 (2279): Removing VM from VirtualBox.
2019-09-28 13:04:33 (2279): Removing virtual disk drive from VirtualBox.
13:04:38 (2279): called boinc_finish(1)

</stderr_txt>
]]>
Development for LHC@home

Stderr output
