Name Theory_2743-2712019-468_1
Workunit 225740088
Created 30 Sep 2024, 16:41:39 UTC
Sent 30 Sep 2024, 22:16:49 UTC
Report deadline 11 Oct 2024, 22:16:49 UTC
Received 1 Oct 2024, 22:27:59 UTC
Server state Over
Outcome Computation error
Client state Compute error
Exit status 1 (0x00000001) Unknown error code
Computer ID 10820906
Run time 16 hours 40 min 7 sec
CPU time 7 min 2 sec
Validate state Invalid
Credit 0.00
Device peak FLOPS 3.22 GFLOPS
Application version Theory Simulation v300.30 (vbox64_theory)
windows_x86_64
Peak working set size 79.38 MB
Peak swap size 76.40 MB
Peak disk usage 149.61 MB

Stderr output

<core_client_version>7.22.2</core_client_version>
<![CDATA[
<message>
 - exit code 1 (0x1)</message>
<stderr_txt>
2024-10-01 12:26:11 (2788): vboxwrapper version 26207
2024-10-01 12:26:11 (2788): BOINC client version: 7.22.2
2024-10-01 12:26:11 (2788): Detected: VirtualBox VboxManage Interface (Version: 6.1.34)
2024-10-01 12:26:11 (2788): Detected: Heartbeat check (file: 'heartbeat' every 1200.000000 seconds)
2024-10-01 12:26:11 (2788): Successfully copied 'init_data.xml' to the shared directory.
2024-10-01 12:26:11 (2788): Successfully copied 'input' to the shared directory.
2024-10-01 12:26:12 (2788): Create VM. (boinc_da96fcc5de88240f, slot#1)
2024-10-01 12:26:12 (2788): Setting Memory Size for VM. (630MB)
2024-10-01 12:26:12 (2788): Setting CPU Count for VM. (1)
2024-10-01 12:26:13 (2788): Setting Chipset Options for VM.
2024-10-01 12:26:13 (2788): Setting Graphics Controller Options for VM.
2024-10-01 12:26:13 (2788): Setting Boot Options for VM.
2024-10-01 12:26:14 (2788): Setting Network Configuration for NAT.
2024-10-01 12:26:14 (2788): Enabling VM Network Access.
2024-10-01 12:26:14 (2788): Disabling USB Support for VM.
2024-10-01 12:26:14 (2788): Disabling COM Port Support for VM.
2024-10-01 12:26:15 (2788): Disabling LPT Port Support for VM.
2024-10-01 12:26:15 (2788): Disabling Audio Support for VM.
2024-10-01 12:26:15 (2788): Disabling Clipboard Support for VM.
2024-10-01 12:26:15 (2788): Disabling Drag and Drop Support for VM.
2024-10-01 12:26:16 (2788): Adding storage controller(s) to VM.
2024-10-01 12:26:16 (2788): Adding virtual disk drive to VM. (Theory_2024_04_30_prod.vdi)
2024-10-01 12:26:17 (2788): Adding VirtualBox Guest Additions to VM.
2024-10-01 12:26:17 (2788): Adding network bandwidth throttle group to VM. (Defaulting to 1024GB)
2024-10-01 12:26:17 (2788): forwarding host port 9964 to guest port 80
2024-10-01 12:26:18 (2788): Enabling remote desktop for VM.
2024-10-01 12:26:18 (2788): Required extension pack not installed, remote desktop not enabled.
2024-10-01 12:26:18 (2788): Enabling shared directory for VM.
2024-10-01 12:26:18 (2788): Starting VM using VBoxManage interface. (boinc_da96fcc5de88240f, slot#1)
2024-10-01 12:26:24 (2788): Successfully started VM. (PID = '16176')
2024-10-01 12:26:24 (2788): Reporting VM Process ID to BOINC.
2024-10-01 12:26:24 (2788): Guest Log: BIOS: VirtualBox 6.1.34
2024-10-01 12:26:24 (2788): Guest Log: CPUID EDX: 0x178bfbff
2024-10-01 12:26:24 (2788): Guest Log: BIOS: No PCI IDE controller, not probing IDE
2024-10-01 12:26:24 (2788): Guest Log: BIOS: AHCI 0-P#0: PCHS=16383/16/63 LCHS=1024/255/63 0x0000000002800000 sectors
2024-10-01 12:26:24 (2788): VM state change detected. (old = 'poweredoff', new = 'running')
2024-10-01 12:26:24 (2788): Detected: Web Application Enabled (http://localhost:9964)
2024-10-01 12:26:24 (2788): Preference change detected
2024-10-01 12:26:24 (2788): Setting CPU throttle for VM. (50%)
2024-10-01 12:26:24 (2788): Setting checkpoint interval to 600 seconds. (Higher value of (Preference: 30 seconds) or (Vbox_job.xml: 600 seconds))
2024-10-01 12:26:26 (2788): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032
2024-10-01 12:26:26 (2788): Guest Log: BIOS: Booting from Hard Disk...
2024-10-01 12:26:29 (2788): Guest Log: BIOS: KBD: unsupported int 16h function 03
2024-10-01 12:26:29 (2788): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 
2024-10-01 12:27:03 (2788): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds
2024-10-01 12:27:03 (2788): Guest Log: vboxguest: misc device minor 56, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000)
2024-10-01 12:27:10 (2788): Guest Log: VBoxService 5.2.6 r120293 (verbosity: 0) linux.amd64 (Jan 15 2018 14:51:00) release log
2024-10-01 12:27:10 (2788): Guest Log: 00:00:00.000192 main     Log opened 2024-10-01T04:27:10.758829000Z
2024-10-01 12:27:10 (2788): Guest Log: 00:00:00.000821 main     OS Product: Linux
2024-10-01 12:27:10 (2788): Guest Log: 00:00:00.000926 main     OS Release: 4.14.76-13.cernvm.x86_64
2024-10-01 12:27:10 (2788): Guest Log: 00:00:00.000984 main     OS Version: #1 SMP Tue Oct 16 18:26:15 CEST 2018
2024-10-01 12:27:10 (2788): Guest Log: 00:00:00.001038 main     Executable: /usr/sbin/VBoxService
2024-10-01 12:27:10 (2788): Guest Log: 00:00:00.001040 main     Process ID: 3221
2024-10-01 12:27:10 (2788): Guest Log: 00:00:00.001041 main     Package type: LINUX_64BITS_GENERIC
2024-10-01 12:27:10 (2788): Guest Log: 00:00:00.004654 main     5.2.6 r120293 started. Verbose level = 0
2024-10-01 12:28:17 (2788): Guest Log: 12:28:17 CST +08:00 2024-10-01: cranky: [INFO] Detected Theory App
2024-10-01 12:28:17 (2788): Guest Log: 12:28:17 CST +08:00 2024-10-01: cranky: [INFO] Checking CVMFS.
2024-10-01 12:28:19 (2788): Guest Log: Probing /cvmfs/sft.cern.ch... OK
2024-10-01 12:28:20 (2788): Guest Log: VERSION PID UPTIME(M) MEM(K) REVISION EXPIRES(M) NOCATALOGS CACHEUSE(K) CACHEMAX(K) NOFDUSE NOFDMAX NOIOERR NOOPEN HITRATE(%) RX(K) SPEED(K/S) HOST PROXY ONLINE
2024-10-01 12:28:20 (2788): Guest Log: 2.5.2.0 4339 0 27204 30600 3 1 260387 4096000 0 65024 0 0 n/a 5 0 http://s1fnal-cvmfs.openhtc.io/cvmfs/sft.cern.ch DIRECT 0
2024-10-01 12:28:22 (2788): Guest Log: Probing /cvmfs/grid.cern.ch... Failed!
2024-10-01 12:28:22 (2788): Guest Log: 12:28:22 CST +08:00 2024-10-01: cranky: [ERROR] 'cvmfs_config probe grid.cern.ch' failed.
2024-10-01 13:05:45 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-01 13:06:05 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-01 14:06:49 (2788): Status Report: Job Duration: '864000.000000'
2024-10-01 14:06:49 (2788): Status Report: Elapsed Time: '6000.000000'
2024-10-01 14:06:49 (2788): Status Report: CPU Time: '66.031250'
2024-10-01 14:14:39 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-01 14:15:19 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-01 15:47:35 (2788): Status Report: Job Duration: '864000.000000'
2024-10-01 15:47:35 (2788): Status Report: Elapsed Time: '12000.000000'
2024-10-01 15:47:35 (2788): Status Report: CPU Time: '95.109375'
2024-10-01 17:27:39 (2788): Status Report: Job Duration: '864000.000000'
2024-10-01 17:27:39 (2788): Status Report: Elapsed Time: '18000.000000'
2024-10-01 17:27:39 (2788): Status Report: CPU Time: '123.031250'
2024-10-01 19:03:35 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-01 19:03:55 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-01 19:05:46 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-01 19:06:06 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-01 19:08:27 (2788): Status Report: Job Duration: '864000.000000'
2024-10-01 19:08:27 (2788): Status Report: Elapsed Time: '24000.000000'
2024-10-01 19:08:27 (2788): Status Report: CPU Time: '154.109375'
2024-10-01 20:02:59 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-01 20:03:19 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-01 20:15:49 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-01 20:16:49 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-01 20:17:50 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-01 20:18:30 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-01 20:50:35 (2788): Status Report: Job Duration: '864000.000000'
2024-10-01 20:50:35 (2788): Status Report: Elapsed Time: '30000.000000'
2024-10-01 20:50:35 (2788): Status Report: CPU Time: '182.671875'
2024-10-01 21:27:34 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-01 21:27:54 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-01 22:31:00 (2788): Status Report: Job Duration: '864000.000000'
2024-10-01 22:31:00 (2788): Status Report: Elapsed Time: '36000.000000'
2024-10-01 22:31:00 (2788): Status Report: CPU Time: '210.703125'
2024-10-01 22:32:57 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-01 22:33:17 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-01 22:47:07 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-01 22:56:47 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-01 22:57:07 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-01 22:58:27 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-01 22:58:47 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-01 23:07:33 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-01 23:07:53 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-01 23:08:13 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-01 23:08:23 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-01 23:08:43 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-01 23:12:03 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-01 23:12:44 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-01 23:54:26 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-01 23:54:47 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-01 23:55:37 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-01 23:55:57 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-01 23:56:07 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-01 23:56:27 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-01 23:57:07 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-01 23:57:27 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-01 23:57:47 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-01 23:58:07 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 00:00:07 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 00:00:27 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 00:00:37 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 00:00:57 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 00:01:07 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 00:01:27 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 00:01:37 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 00:01:57 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 00:02:07 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 00:02:27 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 00:02:47 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 00:04:07 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 00:04:17 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 00:04:38 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 00:04:47 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 00:05:07 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 00:05:17 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 00:06:17 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 00:06:27 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 00:06:47 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 00:07:08 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 00:07:28 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 00:07:38 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 00:08:18 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 00:08:28 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 00:08:48 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 00:08:58 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 00:09:18 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 00:09:48 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 00:10:08 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 00:45:56 (2788): Status Report: Job Duration: '864000.000000'
2024-10-02 00:45:56 (2788): Status Report: Elapsed Time: '42000.000000'
2024-10-02 00:45:56 (2788): Status Report: CPU Time: '257.953125'
2024-10-02 01:10:52 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 01:11:12 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 01:11:22 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 01:11:42 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 01:12:32 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 01:12:52 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 01:13:02 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 01:13:22 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 01:17:22 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 01:17:42 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 01:19:12 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 01:19:32 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 01:20:02 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 01:20:23 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 01:21:03 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 01:21:23 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 01:24:43 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 01:25:03 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 02:25:57 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 02:26:37 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 02:26:57 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 02:27:17 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 02:29:57 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 02:30:17 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 02:30:27 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 02:30:47 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 02:30:55 (2788): Status Report: Job Duration: '864000.000000'
2024-10-02 02:30:55 (2788): Status Report: Elapsed Time: '48000.000000'
2024-10-02 02:30:55 (2788): Status Report: CPU Time: '292.156250'
2024-10-02 02:30:57 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 02:31:37 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 02:31:47 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 02:32:07 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 02:32:17 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 02:32:37 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 02:32:47 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 02:33:07 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 02:33:17 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 02:33:37 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 02:33:47 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 02:34:07 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 02:34:17 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 02:34:37 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 02:34:47 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 02:35:07 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 02:35:17 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 02:35:37 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 02:35:47 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 02:36:07 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 02:36:17 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 02:36:37 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 02:36:47 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 02:37:07 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 02:37:17 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 02:37:37 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 02:37:47 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 02:38:07 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 02:38:17 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 02:38:37 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 02:38:48 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 02:39:08 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 02:39:18 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 02:39:38 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 02:39:48 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 02:40:08 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 02:40:18 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 02:40:38 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 02:40:58 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 02:41:18 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 02:41:28 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 02:41:48 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 03:42:32 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 03:42:52 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 03:49:02 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 03:49:22 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 03:50:22 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 03:50:42 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 03:51:42 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 03:52:02 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 03:52:12 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 03:52:32 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 03:52:42 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 03:53:02 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 03:53:12 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 03:53:32 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 03:53:42 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 03:54:02 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 03:54:12 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 03:54:32 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 03:54:42 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 03:55:02 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 03:56:03 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 03:56:23 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 03:56:33 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 03:56:53 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 04:22:54 (2788): Status Report: Job Duration: '864000.000000'
2024-10-02 04:22:54 (2788): Status Report: Elapsed Time: '54000.000000'
2024-10-02 04:22:54 (2788): Status Report: CPU Time: '327.906250'
2024-10-02 04:35:05 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 04:35:45 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 05:01:06 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 05:01:26 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 05:03:07 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 05:03:28 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 05:03:38 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 05:03:57 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 05:04:08 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 05:04:28 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 05:04:48 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 05:05:08 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 05:05:38 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 05:06:17 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 05:11:18 (2788): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 05:11:38 (2788): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 06:01:18 (2788): Stopping VM.
2024-10-02 06:01:19 (2788): Error in stop VM for VM: -108
Command:
VBoxManage -q controlvm "boinc_da96fcc5de88240f" savestate
Output:

2024-10-02 06:01:19 (2788): VM did not stop when requested.
2024-10-02 06:01:19 (2788): VM was NOT successfully terminated.
2024-10-02 06:05:58 (1664): vboxwrapper version 26207
2024-10-02 06:05:58 (1664): BOINC client version: 7.22.2
2024-10-02 06:06:12 (1664): Detected: VirtualBox VboxManage Interface (Version: 6.1.34)
2024-10-02 06:06:13 (1664): Detected: Heartbeat check (file: 'heartbeat' every 1200.000000 seconds)
2024-10-02 06:06:14 (1664): Guest Log: BIOS: VirtualBox 6.1.34
2024-10-02 06:06:14 (1664): Guest Log: CPUID EDX: 0x178bfbff
2024-10-02 06:06:15 (1664): Guest Log: BIOS: No PCI IDE controller, not probing IDE
2024-10-02 06:06:15 (1664): Guest Log: BIOS: AHCI 0-P#0: PCHS=16383/16/63 LCHS=1024/255/63 0x0000000002800000 sectors
2024-10-02 06:06:15 (1664): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032
2024-10-02 06:06:15 (1664): Guest Log: BIOS: Booting from Hard Disk...
2024-10-02 06:06:15 (1664): Guest Log: BIOS: KBD: unsupported int 16h function 03
2024-10-02 06:06:15 (1664): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 
2024-10-02 06:06:15 (1664): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds
2024-10-02 06:06:15 (1664): Guest Log: vboxguest: misc device minor 56, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000)
2024-10-02 06:06:15 (1664): Guest Log: VBoxService 5.2.6 r120293 (verbosity: 0) linux.amd64 (Jan 15 2018 14:51:00) release log
2024-10-02 06:06:15 (1664): Guest Log: 00:00:00.000192 main     Log opened 2024-10-01T04:27:10.758829000Z
2024-10-02 06:06:15 (1664): Guest Log: 00:00:00.000821 main     OS Product: Linux
2024-10-02 06:06:15 (1664): Guest Log: 00:00:00.000926 main     OS Release: 4.14.76-13.cernvm.x86_64
2024-10-02 06:06:15 (1664): Guest Log: 00:00:00.000984 main     OS Version: #1 SMP Tue Oct 16 18:26:15 CEST 2018
2024-10-02 06:06:15 (1664): Guest Log: 00:00:00.001038 main     Executable: /usr/sbin/VBoxService
2024-10-02 06:06:15 (1664): Guest Log: 00:00:00.001040 main     Process ID: 3221
2024-10-02 06:06:15 (1664): Guest Log: 00:00:00.001041 main     Package type: LINUX_64BITS_GENERIC
2024-10-02 06:06:15 (1664): Guest Log: 00:00:00.004654 main     5.2.6 r120293 started. Verbose level = 0
2024-10-02 06:06:15 (1664): Guest Log: 12:28:17 CST +08:00 2024-10-01: cranky: [INFO] Detected Theory App
2024-10-02 06:06:15 (1664): Guest Log: 12:28:17 CST +08:00 2024-10-01: cranky: [INFO] Checking CVMFS.
2024-10-02 06:06:15 (1664): Guest Log: Probing /cvmfs/sft.cern.ch... OK
2024-10-02 06:06:15 (1664): Guest Log: VERSION PID UPTIME(M) MEM(K) REVISION EXPIRES(M) NOCATALOGS CACHEUSE(K) CACHEMAX(K) NOFDUSE NOFDMAX NOIOERR NOOPEN HITRATE(%) RX(K) SPEED(K/S) HOST PROXY ONLINE
2024-10-02 06:06:15 (1664): Guest Log: 2.5.2.0 4339 0 27204 30600 3 1 260387 4096000 0 65024 0 0 n/a 5 0 http://s1fnal-cvmfs.openhtc.io/cvmfs/sft.cern.ch DIRECT 0
2024-10-02 06:06:15 (1664): Guest Log: Probing /cvmfs/grid.cern.ch... Failed!
2024-10-02 06:06:15 (1664): Guest Log: 12:28:22 CST +08:00 2024-10-01: cranky: [ERROR] 'cvmfs_config probe grid.cern.ch' failed.
2024-10-02 06:06:16 (1664): Starting VM using VBoxManage interface. (boinc_da96fcc5de88240f, slot#1)
2024-10-02 06:06:33 (1664): Successfully started VM. (PID = '14724')
2024-10-02 06:06:33 (1664): Reporting VM Process ID to BOINC.
2024-10-02 06:06:33 (1664): Guest Log: BIOS: VirtualBox 6.1.34
2024-10-02 06:06:33 (1664): Guest Log: CPUID EDX: 0x178bfbff
2024-10-02 06:06:33 (1664): Guest Log: BIOS: No PCI IDE controller, not probing IDE
2024-10-02 06:06:33 (1664): Guest Log: BIOS: AHCI 0-P#0: PCHS=16383/16/63 LCHS=1024/255/63 0x0000000002800000 sectors
2024-10-02 06:06:33 (1664): VM state change detected. (old = 'poweredoff', new = 'running')
2024-10-02 06:06:33 (1664): Detected: Web Application Enabled (http://localhost:9964)
2024-10-02 06:06:34 (1664): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 06:07:10 (1664): Status Report: Job Duration: '864000.000000'
2024-10-02 06:07:10 (1664): Status Report: Elapsed Time: '59691.000000'
2024-10-02 06:07:10 (1664): Status Report: CPU Time: '359.015625'
2024-10-02 06:07:10 (1664): Preference change detected
2024-10-02 06:07:10 (1664): Setting CPU throttle for VM. (50%)
2024-10-02 06:07:10 (1664): Setting checkpoint interval to 600 seconds. (Higher value of (Preference: 30 seconds) or (Vbox_job.xml: 600 seconds))
2024-10-02 06:07:10 (1664): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032
2024-10-02 06:07:10 (1664): Guest Log: BIOS: Booting from Hard Disk...
2024-10-02 06:07:10 (1664): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 06:07:14 (1664): Guest Log: BIOS: KBD: unsupported int 16h function 03
2024-10-02 06:07:14 (1664): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 
2024-10-02 06:07:20 (1664): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 06:07:40 (1664): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 06:07:51 (1664): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 06:08:11 (1664): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 06:08:21 (1664): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 06:09:01 (1664): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 06:09:28 (1664): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds
2024-10-02 06:09:28 (1664): Guest Log: vboxguest: misc device minor 56, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000)
2024-10-02 06:09:38 (1664): Guest Log: VBoxService 5.2.6 r120293 (verbosity: 0) linux.amd64 (Jan 15 2018 14:51:00) release log
2024-10-02 06:09:38 (1664): Guest Log: 00:00:00.000260 main     Log opened 2024-10-01T22:09:39.047800000Z
2024-10-02 06:09:38 (1664): Guest Log: 00:00:00.000439 main     OS Product: Linux
2024-10-02 06:09:38 (1664): Guest Log: 00:00:00.000520 main     OS Release: 4.14.76-13.cernvm.x86_64
2024-10-02 06:09:38 (1664): Guest Log: 00:00:00.000605 main     OS Version: #1 SMP Tue Oct 16 18:26:15 CEST 2018
2024-10-02 06:09:38 (1664): Guest Log: 00:00:00.000680 main     Executable: /usr/sbin/VBoxService
2024-10-02 06:09:38 (1664): Guest Log: 00:00:00.000682 main     Process ID: 3244
2024-10-02 06:09:38 (1664): Guest Log: 00:00:00.000684 main     Package type: LINUX_64BITS_GENERIC
2024-10-02 06:09:38 (1664): Guest Log: 00:00:00.005417 main     5.2.6 r120293 started. Verbose level = 0
2024-10-02 06:10:02 (1664): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 06:10:21 (1664): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 06:10:31 (1664): VM state change detected. (old = 'running', new = 'paused')
2024-10-02 06:10:51 (1664): VM state change detected. (old = 'paused', new = 'running')
2024-10-02 06:11:50 (1664): Guest Log: -bash: /home/boinc/cranky: No such file or directory
2024-10-02 06:11:50 (1664): Guest Log: [ERROR] Job Failed
2024-10-02 06:11:50 (1664): Guest Log: [INFO] Shutting Down.
2024-10-02 06:11:50 (1664): VM Completion File Detected.
2024-10-02 06:11:50 (1664): VM Completion Message: Job Failed
.
2024-10-02 06:11:50 (1664): Powering off VM.
2024-10-02 06:11:51 (1664): Successfully stopped VM.
2024-10-02 06:11:51 (1664): Deregistering VM. (boinc_da96fcc5de88240f, slot#1)
2024-10-02 06:11:51 (1664): Removing network bandwidth throttle group from VM.
2024-10-02 06:11:51 (1664): Removing VM from VirtualBox.
2024-10-02 06:11:56 (1664): called boinc_finish(1)

</stderr_txt>
]]>


©2024 CERN