Task 401527442

Name	Theory_2390-1106463-859_0
Workunit	216924455
Created	10 Nov 2023, 17:42:19 UTC
Sent	10 Nov 2023, 21:02:24 UTC
Report deadline	21 Nov 2023, 21:02:24 UTC
Received	23 Nov 2023, 15:55:55 UTC
Server state	Over
Outcome	Success
Client state	Done
Exit status	0 (0x00000000)
Computer ID	10527472
Run time	2 days 12 hours 51 min 24 sec
CPU time	2 days 12 hours 51 min 24 sec
Validate state	Valid
Credit	2,506.37
Device peak FLOPS	4.94 GFLOPS
Application version	Theory Simulation v300.07 (vbox64_theory) windows_x86_64
Peak working set size	78.55 MB
Peak swap size	76.13 MB
Peak disk usage	1.96 GB
Stderr output

<core_client_version>7.16.11</core_client_version>
<![CDATA[
<stderr_txt>
/html/job
2023-11-18 18:49:32 (12160): Guest Log: job: unpack exitcode=0
2023-11-18 18:49:33 (12160): Guest Log: 18:49:31 CET +01:00 2023-11-18: cranky: [INFO] ===> [runRivet] Sat Nov 18 17:49:31 UTC 2023 [boinc pp jets 13000 250,-,4760 - pythia8 8.301 cr1 100000 859]
2023-11-18 20:32:12 (12160): Status Report: Job Duration: '864000.000000'
2023-11-18 20:32:12 (12160): Status Report: Elapsed Time: '6000.801302'
2023-11-18 20:32:12 (12160): Status Report: CPU Time: '4824.187500'
2023-11-18 22:15:51 (12160): Status Report: Job Duration: '864000.000000'
2023-11-18 22:15:57 (12160): Status Report: Elapsed Time: '12001.433599'
2023-11-18 22:15:57 (12160): Status Report: CPU Time: '10067.828125'
2023-11-19 00:00:16 (12160): Status Report: Job Duration: '864000.000000'
2023-11-19 00:00:16 (12160): Status Report: Elapsed Time: '18002.119989'
2023-11-19 00:00:16 (12160): Status Report: CPU Time: '15274.265625'
2023-11-19 01:45:06 (12160): Status Report: Job Duration: '864000.000000'
2023-11-19 01:45:06 (12160): Status Report: Elapsed Time: '24002.977947'
2023-11-19 01:45:06 (12160): Status Report: CPU Time: '20390.093750'
2023-11-19 03:28:29 (12160): Status Report: Job Duration: '864000.000000'
2023-11-19 03:28:29 (12160): Status Report: Elapsed Time: '30003.375881'
2023-11-19 03:28:29 (12160): Status Report: CPU Time: '25384.250000'
2023-11-19 18:28:12 (13516): Detected: vboxwrapper 26206
2023-11-19 18:28:12 (13516): Detected: BOINC client v7.16.11
2023-11-19 18:28:37 (13516): Detected: VirtualBox VboxManage Interface (Version: 6.1.12)
2023-11-19 18:28:43 (13516): Detected: Heartbeat check (file: 'heartbeat' every 1200.000000 seconds)
2023-11-19 18:28:51 (13516): Guest Log: BIOS: VirtualBox 6.1.12
2023-11-19 18:28:51 (13516): Guest Log: CPUID EDX: 0x178bfbff
2023-11-19 18:28:51 (13516): Guest Log: BIOS: No PCI IDE controller, not probing IDE
2023-11-19 18:28:51 (13516): Guest Log: BIOS: AHCI 0-P#0: PCHS=16383/16/63 LCHS=1024/255/63 0x0000000002800000 sectors
2023-11-19 18:28:51 (13516): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032
2023-11-19 18:28:51 (13516): Guest Log: BIOS: Booting from Hard Disk...
2023-11-19 18:28:51 (13516): Guest Log: BIOS: KBD: unsupported int 16h function 03
2023-11-19 18:28:51 (13516): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 
2023-11-19 18:28:51 (13516): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds
2023-11-19 18:28:51 (13516): Guest Log: vboxguest: misc device minor 56, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000)
2023-11-19 18:28:52 (13516): Guest Log: VBoxService 5.2.6 r120293 (verbosity: 0) linux.amd64 (Jan 15 2018 14:51:00) release log
2023-11-19 18:28:52 (13516): Guest Log: 00:00:00.000068 main     Log opened 2023-11-18T17:49:01.520940000Z
2023-11-19 18:28:52 (13516): Guest Log: 00:00:00.000138 main     OS Product: Linux
2023-11-19 18:28:52 (13516): Guest Log: 00:00:00.000168 main     OS Release: 4.14.76-13.cernvm.x86_64
2023-11-19 18:28:52 (13516): Guest Log: 00:00:00.000202 main     OS Version: #1 SMP Tue Oct 16 18:26:15 CEST 2018
2023-11-19 18:28:53 (13516): Guest Log: 00:00:00.000223 main     Executable: /usr/sbin/VBoxService
2023-11-19 18:28:53 (13516): Guest Log: 00:00:00.000224 main     Process ID: 3225
2023-11-19 18:28:53 (13516): Guest Log: 00:00:00.000224 main     Package type: LINUX_64BITS_GENERIC
2023-11-19 18:28:53 (13516): Guest Log: 00:00:00.000893 main     5.2.6 r120293 started. Verbose level = 0
2023-11-19 18:28:53 (13516): Guest Log: 18:49:24 CET +01:00 2023-11-18: cranky: [INFO] Detected Theory App
2023-11-19 18:28:53 (13516): Guest Log: 18:49:24 CET +01:00 2023-11-18: cranky: [INFO] Checking CVMFS.
2023-11-19 18:28:53 (13516): Guest Log: Probing /cvmfs/sft.cern.ch... OK
2023-11-19 18:28:54 (13516): 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
2023-11-19 18:28:54 (13516): Guest Log: 2.5.2.0 4106 0 25120 27637 3 1 269475 4096000 0 65024 0 0 n/a 5 4 http://s1fnal-cvmfs.openhtc.io/cvmfs/sft.cern.ch DIRECT 1
2023-11-19 18:28:54 (13516): Guest Log: Probing /cvmfs/grid.cern.ch... OK
2023-11-19 18:28:54 (13516): 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
2023-11-19 18:28:54 (13516): Guest Log: 2.5.2.0 4059 0 27508 22749 3 2 269475 4096000 0 65024 0 2 -100 7837 7980 http://s1cern-cvmfs.openhtc.io/cvmfs/grid.cern.ch DIRECT 1
2023-11-19 18:28:54 (13516): Guest Log: Probing /cvmfs/cernvm-prod.cern.ch... OK
2023-11-19 18:28:54 (13516): 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
2023-11-19 18:28:54 (13516): Guest Log: 2.5.2.0 4081 0 27228 268 3 1 269475 4096000 0 65024 0 0 n/a 4 4 http://s1unl-cvmfs.openhtc.io/cvmfs/cernvm-prod.cern.ch DIRECT 1
2023-11-19 18:28:58 (13516): Guest Log: Probing /cvmfs/alice.cern.ch... OK
2023-11-19 18:28:58 (13516): 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
2023-11-19 18:28:58 (13516): Guest Log: 2.5.2.0 4131 0 38204 17129 3 1 269475 4096000 0 65024 0 0 n/a 4601 2091 http://s1unl-cvmfs.openhtc.io/cvmfs/alice.cern.ch DIRECT 1
2023-11-19 18:28:58 (13516): Guest Log: 18:49:29 CET +01:00 2023-11-18: cranky: [INFO] Checking runc.
2023-11-19 18:28:58 (13516): Guest Log: 18:49:29 CET +01:00 2023-11-18: cranky: [INFO] Creating the filesystem.
2023-11-19 18:28:59 (13516): Guest Log: 18:49:29 CET +01:00 2023-11-18: cranky: [INFO] Using /cvmfs/cernvm-prod.cern.ch/cvm3
2023-11-19 18:28:59 (13516): Guest Log: 18:49:29 CET +01:00 2023-11-18: cranky: [INFO] Updating config.json.
2023-11-19 18:29:03 (13516): Guest Log: 18:49:29 CET +01:00 2023-11-18: cranky: [INFO] Running Container 'runc'.
2023-11-19 18:29:03 (13516): Guest Log: job: htmld=/shared/html/job
2023-11-19 18:29:03 (13516): Guest Log: job: unpack exitcode=0
2023-11-19 18:29:03 (13516): Guest Log: 18:49:31 CET +01:00 2023-11-18: cranky: [INFO] ===> [runRivet] Sat Nov 18 17:49:31 UTC 2023 [boinc pp jets 13000 250,-,4760 - pythia8 8.301 cr1 100000 859]
2023-11-19 18:29:03 (13516): Starting VM using VBoxManage interface. (boinc_65fa58beaec03109, slot#1)
2023-11-19 18:30:13 (13516): Successfully started VM. (PID = '10504')
2023-11-19 18:30:13 (13516): Reporting VM Process ID to BOINC.
2023-11-19 18:30:13 (13516): Guest Log: BIOS: VirtualBox 6.1.12
2023-11-19 18:30:13 (13516): Guest Log: CPUID EDX: 0x178bfbff
2023-11-19 18:30:13 (13516): Guest Log: BIOS: No PCI IDE controller, not probing IDE
2023-11-19 18:30:13 (13516): Guest Log: BIOS: AHCI 0-P#0: PCHS=16383/16/63 LCHS=1024/255/63 0x0000000002800000 sectors
2023-11-19 18:30:13 (13516): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032
2023-11-19 18:30:13 (13516): Guest Log: BIOS: Booting from Hard Disk...
2023-11-19 18:30:13 (13516): Guest Log: BIOS: KBD: unsupported int 16h function 03
2023-11-19 18:30:13 (13516): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 
2023-11-19 18:30:13 (13516): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds
2023-11-19 18:30:13 (13516): Guest Log: vboxguest: misc device minor 56, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000)
2023-11-19 18:30:13 (13516): Guest Log: VBoxService 5.2.6 r120293 (verbosity: 0) linux.amd64 (Jan 15 2018 14:51:00) release log
2023-11-19 18:30:13 (13516): Guest Log: 00:00:00.000074 main     Log opened 2023-11-19T17:29:51.186129000Z
2023-11-19 18:30:13 (13516): Guest Log: 00:00:00.000157 main     OS Product: Linux
2023-11-19 18:30:13 (13516): Guest Log: 00:00:00.000191 main     OS Release: 4.14.76-13.cernvm.x86_64
2023-11-19 18:30:13 (13516): Guest Log: 00:00:00.000214 main     OS Version: #1 SMP Tue Oct 16 18:26:15 CEST 2018
2023-11-19 18:30:13 (13516): Guest Log: 00:00:00.000234 main     Executable: /usr/sbin/VBoxService
2023-11-19 18:30:13 (13516): Guest Log: 00:00:00.000235 main     Process ID: 3216
2023-11-19 18:30:13 (13516): Guest Log: 00:00:00.000236 main     Package type: LINUX_64BITS_GENERIC
2023-11-19 18:30:13 (13516): Guest Log: 00:00:00.003099 main     5.2.6 r120293 started. Verbose level = 0
2023-11-19 18:30:13 (13516): VM state change detected. (old = 'poweredoff', new = 'running')
2023-11-19 18:30:13 (13516): Detected: Web Application Enabled (http://localhost:50277)
2023-11-19 18:30:13 (13516): Status Report: Job Duration: '864000.000000'
2023-11-19 18:30:13 (13516): Status Report: Elapsed Time: '35593.857342'
2023-11-19 18:30:13 (13516): Status Report: CPU Time: '30208.765625'
2023-11-19 18:30:22 (13516): Preference change detected
2023-11-19 18:30:22 (13516): Setting CPU throttle for VM. (100%)
2023-11-19 18:35:59 (13516): Error in CPU throttle for VM: -182
Command:
VBoxManage -q controlvm "boinc_65fa58beaec03109" cpuexecutioncap 100 
Output:

2023-11-19 18:35:59 (13516): Setting checkpoint interval to 600 seconds. (Higher value of (Preference: 60 seconds) or (Vbox_job.xml: 600 seconds))
2023-11-19 18:36:00 (13516): Guest Log: 18:30:20 CET +01:00 2023-11-19: cranky: [INFO] Detected Theory App
2023-11-19 18:36:00 (13516): Guest Log: 18:30:20 CET +01:00 2023-11-19: cranky: [INFO] Checking CVMFS.
2023-11-19 18:36:00 (13516): Guest Log: Probing /cvmfs/sft.cern.ch... OK
2023-11-19 18:36:00 (13516): 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
2023-11-19 18:36:00 (13516): Guest Log: 2.5.2.0 4081 0 28392 27644 3 1 1071094 4096000 0 65024 0 0 n/a 5 16 http://s1ral-cvmfs.openhtc.io/cvmfs/sft.cern.ch DIRECT 1
2023-11-19 18:36:00 (13516): Guest Log: Probing /cvmfs/grid.cern.ch... OK
2023-11-19 18:36:00 (13516): 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
2023-11-19 18:36:00 (13516): Guest Log: 2.5.2.0 4059 0 27760 22757 3 2 1071094 4096000 0 65024 0 2 0 5697 6814 http://s1unl-cvmfs.openhtc.io/cvmfs/grid.cern.ch DIRECT 1
2023-11-19 18:36:00 (13516): Guest Log: Probing /cvmfs/cernvm-prod.cern.ch... OK
2023-11-19 18:36:00 (13516): 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
2023-11-19 18:36:00 (13516): Guest Log: 2.5.2.0 4127 0 25128 268 3 1 1071094 4096000 0 65024 0 0 n/a 0 0 http://s1asgc-cvmfs.openhtc.io:8080/cvmfs/cernvm-prod.cern.ch DIRECT 1
2023-11-19 18:36:00 (13516): Guest Log: Probing /cvmfs/alice.cern.ch... OK
2023-11-19 18:36:00 (13516): 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
2023-11-19 18:36:00 (13516): Guest Log: 2.5.2.0 4103 0 35536 17135 3 1 1071094 4096000 0 65024 0 0 n/a 4602 9222 http://s1cern-cvmfs.openhtc.io/cvmfs/alice.cern.ch DIRECT 1
2023-11-19 18:36:00 (13516): Guest Log: 18:30:30 CET +01:00 2023-11-19: cranky: [INFO] Checking runc.
2023-11-19 18:36:00 (13516): Guest Log: 18:30:30 CET +01:00 2023-11-19: cranky: [INFO] Creating the filesystem.
2023-11-19 18:36:06 (13516): Guest Log: 18:30:30 CET +01:00 2023-11-19: cranky: [INFO] Using /cvmfs/cernvm-prod.cern.ch/cvm3
2023-11-19 18:36:06 (13516): Guest Log: 18:30:30 CET +01:00 2023-11-19: cranky: [INFO] Updating config.json.
2023-11-19 18:36:06 (13516): Guest Log: 18:30:30 CET +01:00 2023-11-19: cranky: [INFO] Running Container 'runc'.
2023-11-19 18:36:06 (13516): Guest Log: job: htmld=/shared/html/job
2023-11-19 18:36:06 (13516): Guest Log: job: unpack exitcode=0
2023-11-19 18:36:06 (13516): Guest Log: 18:30:32 CET +01:00 2023-11-19: cranky: [INFO] ===> [runRivet] Sun Nov 19 17:30:31 UTC 2023 [boinc pp jets 13000 250,-,4760 - pythia8 8.301 cr1 100000 859]
2023-11-19 20:19:13 (13516): Status Report: Job Duration: '864000.000000'
2023-11-19 20:19:13 (13516): Status Report: Elapsed Time: '41594.285784'
2023-11-19 20:19:13 (13516): Status Report: CPU Time: '35255.875000'
2023-11-19 22:04:11 (13516): Status Report: Job Duration: '864000.000000'
2023-11-19 22:04:11 (13516): Status Report: Elapsed Time: '47594.826672'
2023-11-19 22:04:11 (13516): Status Report: CPU Time: '40744.859375'
2023-11-19 23:47:54 (13516): Status Report: Job Duration: '864000.000000'
2023-11-19 23:47:54 (13516): Status Report: Elapsed Time: '53594.835509'
2023-11-19 23:47:54 (13516): Status Report: CPU Time: '45973.312500'
2023-11-20 01:31:43 (13516): Status Report: Job Duration: '864000.000000'
2023-11-20 01:31:43 (13516): Status Report: Elapsed Time: '59595.450417'
2023-11-20 01:31:43 (13516): Status Report: CPU Time: '51145.718750'
2023-11-20 03:14:43 (13516): Status Report: Job Duration: '864000.000000'
2023-11-20 03:14:43 (13516): Status Report: Elapsed Time: '65595.847298'
2023-11-20 03:14:43 (13516): Status Report: CPU Time: '56259.890625'
2023-11-20 04:58:13 (13516): Status Report: Job Duration: '864000.000000'
2023-11-20 04:58:13 (13516): Status Report: Elapsed Time: '71596.316767'
2023-11-20 04:58:13 (13516): Status Report: CPU Time: '61401.140625'
2023-11-20 05:55:09 (13516): Stopping VM.
2023-11-20 12:13:44 (1428): Detected: vboxwrapper 26206
2023-11-20 12:13:44 (1428): Detected: BOINC client v7.16.11
2023-11-20 12:13:45 (1428): Detected: VirtualBox VboxManage Interface (Version: 6.1.12)
2023-11-20 12:13:45 (1428): Detected: Heartbeat check (file: 'heartbeat' every 1200.000000 seconds)
2023-11-20 12:13:47 (1428): Guest Log: BIOS: VirtualBox 6.1.12
2023-11-20 12:13:47 (1428): Guest Log: CPUID EDX: 0x178bfbff
2023-11-20 12:13:47 (1428): Guest Log: BIOS: No PCI IDE controller, not probing IDE
2023-11-20 12:13:47 (1428): Guest Log: BIOS: AHCI 0-P#0: PCHS=16383/16/63 LCHS=1024/255/63 0x0000000002800000 sectors
2023-11-20 12:13:47 (1428): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032
2023-11-20 12:13:47 (1428): Guest Log: BIOS: Booting from Hard Disk...
2023-11-20 12:13:47 (1428): Guest Log: BIOS: KBD: unsupported int 16h function 03
2023-11-20 12:13:47 (1428): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 
2023-11-20 12:13:47 (1428): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds
2023-11-20 12:13:47 (1428): Guest Log: vboxguest: misc device minor 56, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000)
2023-11-20 12:13:47 (1428): Guest Log: VBoxService 5.2.6 r120293 (verbosity: 0) linux.amd64 (Jan 15 2018 14:51:00) release log
2023-11-20 12:13:47 (1428): Guest Log: 00:00:00.000074 main     Log opened 2023-11-19T17:29:51.186129000Z
2023-11-20 12:13:47 (1428): Guest Log: 00:00:00.000157 main     OS Product: Linux
2023-11-20 12:13:47 (1428): Guest Log: 00:00:00.000191 main     OS Release: 4.14.76-13.cernvm.x86_64
2023-11-20 12:13:47 (1428): Guest Log: 00:00:00.000214 main     OS Version: #1 SMP Tue Oct 16 18:26:15 CEST 2018
2023-11-20 12:13:47 (1428): Guest Log: 00:00:00.000234 main     Executable: /usr/sbin/VBoxService
2023-11-20 12:13:47 (1428): Guest Log: 00:00:00.000235 main     Process ID: 3216
2023-11-20 12:13:47 (1428): Guest Log: 00:00:00.000236 main     Package type: LINUX_64BITS_GENERIC
2023-11-20 12:13:47 (1428): Guest Log: 00:00:00.003099 main     5.2.6 r120293 started. Verbose level = 0
2023-11-20 12:13:47 (1428): Guest Log: 18:30:20 CET +01:00 2023-11-19: cranky: [INFO] Detected Theory App
2023-11-20 12:13:47 (1428): Guest Log: 18:30:20 CET +01:00 2023-11-19: cranky: [INFO] Checking CVMFS.
2023-11-20 12:13:47 (1428): Guest Log: Probing /cvmfs/sft.cern.ch... OK
2023-11-20 12:13:47 (1428): 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
2023-11-20 12:13:47 (1428): Guest Log: 2.5.2.0 4081 0 28392 27644 3 1 1071094 4096000 0 65024 0 0 n/a 5 16 http://s1ral-cvmfs.openhtc.io/cvmfs/sft.cern.ch DIRECT 1
2023-11-20 12:13:47 (1428): Guest Log: Probing /cvmfs/grid.cern.ch... OK
2023-11-20 12:13:47 (1428): 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
2023-11-20 12:13:47 (1428): Guest Log: 2.5.2.0 4059 0 27760 22757 3 2 1071094 4096000 0 65024 0 2 0 5697 6814 http://s1unl-cvmfs.openhtc.io/cvmfs/grid.cern.ch DIRECT 1
2023-11-20 12:13:47 (1428): Guest Log: Probing /cvmfs/cernvm-prod.cern.ch... OK
2023-11-20 12:13:47 (1428): 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
2023-11-20 12:13:47 (1428): Guest Log: 2.5.2.0 4127 0 25128 268 3 1 1071094 4096000 0 65024 0 0 n/a 0 0 http://s1asgc-cvmfs.openhtc.io:8080/cvmfs/cernvm-prod.cern.ch DIRECT 1
2023-11-20 12:13:47 (1428): Guest Log: Probing /cvmfs/alice.cern.ch... OK
2023-11-20 12:13:47 (1428): 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
2023-11-20 12:13:47 (1428): Guest Log: 2.5.2.0 4103 0 35536 17135 3 1 1071094 4096000 0 65024 0 0 n/a 4602 9222 http://s1cern-cvmfs.openhtc.io/cvmfs/alice.cern.ch DIRECT 1
2023-11-20 12:13:47 (1428): Guest Log: 18:30:30 CET +01:00 2023-11-19: cranky: [INFO] Checking runc.
2023-11-20 12:13:47 (1428): Guest Log: 18:30:30 CET +01:00 2023-11-19: cranky: [INFO] Creating the filesystem.
2023-11-20 12:13:47 (1428): Guest Log: 18:30:30 CET +01:00 2023-11-19: cranky: [INFO] Using /cvmfs/cernvm-prod.cern.ch/cvm3
2023-11-20 12:13:47 (1428): Guest Log: 18:30:30 CET +01:00 2023-11-19: cranky: [INFO] Updating config.json.
2023-11-20 12:13:47 (1428): Guest Log: 18:30:30 CET +01:00 2023-11-19: cranky: [INFO] Running Container 'runc'.
2023-11-20 12:13:47 (1428): Guest Log: job: htmld=/shared/html/job
2023-11-20 12:13:47 (1428): Guest Log: job: unpack exitcode=0
2023-11-20 12:13:47 (1428): Guest Log: 18:30:32 CET +01:00 2023-11-19: cranky: [INFO] ===> [runRivet] Sun Nov 19 17:30:31 UTC 2023 [boinc pp jets 13000 250,-,4760 - pythia8 8.301 cr1 100000 859]
2023-11-20 12:13:47 (1428): Starting VM using VBoxManage interface. (boinc_65fa58beaec03109, slot#1)
2023-11-20 12:13:52 (1428): Successfully started VM. (PID = '13732')
2023-11-20 12:13:52 (1428): Reporting VM Process ID to BOINC.
2023-11-20 12:13:52 (1428): Guest Log: BIOS: VirtualBox 6.1.12
2023-11-20 12:13:52 (1428): Guest Log: CPUID EDX: 0x178bfbff
2023-11-20 12:13:52 (1428): Guest Log: BIOS: No PCI IDE controller, not probing IDE
2023-11-20 12:13:52 (1428): Guest Log: BIOS: AHCI 0-P#0: PCHS=16383/16/63 LCHS=1024/255/63 0x0000000002800000 sectors
2023-11-20 12:13:52 (1428): VM state change detected. (old = 'poweredoff', new = 'running')
2023-11-20 12:13:52 (1428): Detected: Web Application Enabled (http://localhost:50277)
2023-11-20 12:13:52 (1428): Status Report: Job Duration: '864000.000000'
2023-11-20 12:13:52 (1428): Status Report: Elapsed Time: '74989.159222'
2023-11-20 12:13:52 (1428): Status Report: CPU Time: '64079.781250'
2023-11-20 12:13:52 (1428): Preference change detected
2023-11-20 12:13:52 (1428): Setting CPU throttle for VM. (100%)
2023-11-20 12:13:53 (1428): Setting checkpoint interval to 600 seconds. (Higher value of (Preference: 60 seconds) or (Vbox_job.xml: 600 seconds))
2023-11-20 12:13:53 (1428): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032
2023-11-20 12:13:53 (1428): Guest Log: BIOS: Booting from Hard Disk...
2023-11-20 12:13:55 (1428): Guest Log: BIOS: KBD: unsupported int 16h function 03
2023-11-20 12:13:55 (1428): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 
2023-11-20 12:14:17 (1428): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds
2023-11-20 12:14:17 (1428): Guest Log: vboxguest: misc device minor 56, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000)
2023-11-20 12:14:17 (1428): Guest Log: VBoxService 5.2.6 r120293 (verbosity: 0) linux.amd64 (Jan 15 2018 14:51:00) release log
2023-11-20 12:14:17 (1428): Guest Log: 00:00:00.000072 main     Log opened 2023-11-20T11:14:15.605144000Z
2023-11-20 12:14:17 (1428): Guest Log: 00:00:00.000179 main     OS Product: Linux
2023-11-20 12:14:17 (1428): Guest Log: 00:00:00.000214 main     OS Release: 4.14.76-13.cernvm.x86_64
2023-11-20 12:14:17 (1428): Guest Log: 00:00:00.000243 main     OS Version: #1 SMP Tue Oct 16 18:26:15 CEST 2018
2023-11-20 12:14:17 (1428): Guest Log: 00:00:00.000271 main     Executable: /usr/sbin/VBoxService
2023-11-20 12:14:17 (1428): Guest Log: 00:00:00.000271 main     Process ID: 3218
2023-11-20 12:14:17 (1428): Guest Log: 00:00:00.000272 main     Package type: LINUX_64BITS_GENERIC
2023-11-20 12:14:17 (1428): Guest Log: 00:00:00.000957 main     5.2.6 r120293 started. Verbose level = 0
2023-11-20 12:14:33 (1428): Guest Log: 12:14:33 CET +01:00 2023-11-20: cranky: [INFO] Detected Theory App
2023-11-20 12:14:33 (1428): Guest Log: 12:14:33 CET +01:00 2023-11-20: cranky: [INFO] Checking CVMFS.
2023-11-20 12:14:34 (1428): Guest Log: Probing /cvmfs/sft.cern.ch... OK
2023-11-20 12:14:34 (1428): 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
2023-11-20 12:14:34 (1428): Guest Log: 2.5.2.0 4051 0 25144 27650 3 1 1095415 4096000 0 65024 0 0 n/a 5 12 http://s1ral-cvmfs.openhtc.io/cvmfs/sft.cern.ch DIRECT 1
2023-11-20 12:14:34 (1428): Guest Log: Probing /cvmfs/grid.cern.ch... OK
2023-11-20 12:14:35 (1428): 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
2023-11-20 12:14:35 (1428): Guest Log: 2.5.2.0 4073 0 27680 22763 3 2 1095415 4096000 0 65024 0 2 0 5700 4100 http://s1cern-cvmfs.openhtc.io/cvmfs/grid.cern.ch DIRECT 1
2023-11-20 12:14:35 (1428): Guest Log: Probing /cvmfs/cernvm-prod.cern.ch... OK
2023-11-20 12:14:36 (1428): 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
2023-11-20 12:14:36 (1428): Guest Log: 2.5.2.0 4118 0 27616 268 3 1 1095415 4096000 0 65024 0 0 n/a 0 0 http://s1asgc-cvmfs.openhtc.io:8080/cvmfs/cernvm-prod.cern.ch DIRECT 1
2023-11-20 12:14:36 (1428): Guest Log: Probing /cvmfs/alice.cern.ch... OK
2023-11-20 12:14:37 (1428): 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
2023-11-20 12:14:37 (1428): Guest Log: 2.5.2.0 4094 0 37588 17139 3 1 1095415 4096000 0 65024 0 0 n/a 4602 8059 http://s1cern-cvmfs.openhtc.io/cvmfs/alice.cern.ch DIRECT 1
2023-11-20 12:14:37 (1428): Guest Log: 12:14:37 CET +01:00 2023-11-20: cranky: [INFO] Checking runc.
2023-11-20 12:14:37 (1428): Guest Log: 12:14:37 CET +01:00 2023-11-20: cranky: [INFO] Creating the filesystem.
2023-11-20 12:14:37 (1428): Guest Log: 12:14:37 CET +01:00 2023-11-20: cranky: [INFO] Using /cvmfs/cernvm-prod.cern.ch/cvm3
2023-11-20 12:14:37 (1428): Guest Log: 12:14:37 CET +01:00 2023-11-20: cranky: [INFO] Updating config.json.
2023-11-20 12:14:37 (1428): Guest Log: 12:14:37 CET +01:00 2023-11-20: cranky: [INFO] Running Container 'runc'.
2023-11-20 12:14:37 (1428): Guest Log: job: htmld=/shared/html/job
2023-11-20 12:14:37 (1428): Guest Log: job: unpack exitcode=0
2023-11-20 12:14:39 (1428): Guest Log: 12:14:39 CET +01:00 2023-11-20: cranky: [INFO] ===> [runRivet] Mon Nov 20 11:14:38 UTC 2023 [boinc pp jets 13000 250,-,4760 - pythia8 8.301 cr1 100000 859]
2023-11-20 13:57:20 (1428): Status Report: Job Duration: '864000.000000'
2023-11-20 13:57:20 (1428): Status Report: Elapsed Time: '80989.603997'
2023-11-20 13:57:20 (1428): Status Report: CPU Time: '68903.984375'
2023-11-20 15:41:01 (1428): Status Report: Job Duration: '864000.000000'
2023-11-20 15:41:01 (1428): Status Report: Elapsed Time: '86990.345383'
2023-11-20 15:41:01 (1428): Status Report: CPU Time: '74043.875000'
2023-11-20 17:23:59 (1428): Status Report: Job Duration: '864000.000000'
2023-11-20 17:23:59 (1428): Status Report: Elapsed Time: '92990.988638'
2023-11-20 17:23:59 (1428): Status Report: CPU Time: '79073.343750'
2023-11-20 19:08:20 (1428): Status Report: Job Duration: '864000.000000'
2023-11-20 19:08:20 (1428): Status Report: Elapsed Time: '98991.882891'
2023-11-20 19:08:20 (1428): Status Report: CPU Time: '84408.093750'
2023-11-20 20:53:16 (1428): Status Report: Job Duration: '864000.000000'
2023-11-20 20:53:16 (1428): Status Report: Elapsed Time: '104992.875298'
2023-11-20 20:53:16 (1428): Status Report: CPU Time: '90063.296875'
2023-11-20 22:36:16 (1428): Status Report: Job Duration: '864000.000000'
2023-11-20 22:36:16 (1428): Status Report: Elapsed Time: '111004.088461'
2023-11-20 22:36:16 (1428): Status Report: CPU Time: '95099.937500'
2023-11-21 00:19:50 (1428): Status Report: Job Duration: '864000.000000'
2023-11-21 00:19:50 (1428): Status Report: Elapsed Time: '117004.639929'
2023-11-21 00:19:50 (1428): Status Report: CPU Time: '100449.500000'
2023-11-21 02:05:26 (1428): Status Report: Job Duration: '864000.000000'
2023-11-21 02:05:26 (1428): Status Report: Elapsed Time: '123005.260527'
2023-11-21 02:05:26 (1428): Status Report: CPU Time: '106642.593750'
2023-11-21 03:51:24 (1428): Status Report: Job Duration: '864000.000000'
2023-11-21 03:51:24 (1428): Status Report: Elapsed Time: '129005.895270'
2023-11-21 03:51:24 (1428): Status Report: CPU Time: '112858.218750'
2023-11-21 03:56:44 (1428): Stopping VM.
2023-11-21 03:57:34 (1428): Successfully stopped VM.
2023-11-21 04:12:44 (8332): Detected: vboxwrapper 26206
2023-11-21 04:12:44 (8332): Detected: BOINC client v7.16.11
2023-11-21 04:12:45 (8332): Detected: VirtualBox VboxManage Interface (Version: 6.1.12)
2023-11-21 04:12:45 (8332): Detected: Heartbeat check (file: 'heartbeat' every 1200.000000 seconds)
2023-11-21 04:12:46 (8332): Guest Log: BIOS: VirtualBox 6.1.12
2023-11-21 04:12:46 (8332): Guest Log: CPUID EDX: 0x178bfbff
2023-11-21 04:12:46 (8332): Guest Log: BIOS: No PCI IDE controller, not probing IDE
2023-11-21 04:12:46 (8332): Guest Log: BIOS: AHCI 0-P#0: PCHS=16383/16/63 LCHS=1024/255/63 0x0000000002800000 sectors
2023-11-21 04:12:46 (8332): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032
2023-11-21 04:12:46 (8332): Guest Log: BIOS: Booting from Hard Disk...
2023-11-21 04:12:46 (8332): Guest Log: BIOS: KBD: unsupported int 16h function 03
2023-11-21 04:12:46 (8332): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 
2023-11-21 04:12:46 (8332): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds
2023-11-21 04:12:46 (8332): Guest Log: vboxguest: misc device minor 56, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000)
2023-11-21 04:12:46 (8332): Guest Log: VBoxService 5.2.6 r120293 (verbosity: 0) linux.amd64 (Jan 15 2018 14:51:00) release log
2023-11-21 04:12:46 (8332): Guest Log: 00:00:00.000072 main     Log opened 2023-11-20T11:14:15.605144000Z
2023-11-21 04:12:46 (8332): Guest Log: 00:00:00.000179 main     OS Product: Linux
2023-11-21 04:12:46 (8332): Guest Log: 00:00:00.000214 main     OS Release: 4.14.76-13.cernvm.x86_64
2023-11-21 04:12:46 (8332): Guest Log: 00:00:00.000243 main     OS Version: #1 SMP Tue Oct 16 18:26:15 CEST 2018
2023-11-21 04:12:46 (8332): Guest Log: 00:00:00.000271 main     Executable: /usr/sbin/VBoxService
2023-11-21 04:12:46 (8332): Guest Log: 00:00:00.000271 main     Process ID: 3218
2023-11-21 04:12:46 (8332): Guest Log: 00:00:00.000272 main     Package type: LINUX_64BITS_GENERIC
2023-11-21 04:12:46 (8332): Guest Log: 00:00:00.000957 main     5.2.6 r120293 started. Verbose level = 0
2023-11-21 04:12:46 (8332): Guest Log: 12:14:33 CET +01:00 2023-11-20: cranky: [INFO] Detected Theory App
2023-11-21 04:12:46 (8332): Guest Log: 12:14:33 CET +01:00 2023-11-20: cranky: [INFO] Checking CVMFS.
2023-11-21 04:12:46 (8332): Guest Log: Probing /cvmfs/sft.cern.ch... OK
2023-11-21 04:12:46 (8332): 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
2023-11-21 04:12:46 (8332): Guest Log: 2.5.2.0 4051 0 25144 27650 3 1 1095415 4096000 0 65024 0 0 n/a 5 12 http://s1ral-cvmfs.openhtc.io/cvmfs/sft.cern.ch DIRECT 1
2023-11-21 04:12:46 (8332): Guest Log: Probing /cvmfs/grid.cern.ch... OK
2023-11-21 04:12:46 (8332): 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
2023-11-21 04:12:46 (8332): Guest Log: 2.5.2.0 4073 0 27680 22763 3 2 1095415 4096000 0 65024 0 2 0 5700 4100 http://s1cern-cvmfs.openhtc.io/cvmfs/grid.cern.ch DIRECT 1
2023-11-21 04:12:46 (8332): Guest Log: Probing /cvmfs/cernvm-prod.cern.ch... OK
2023-11-21 04:12:46 (8332): 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
2023-11-21 04:12:46 (8332): Guest Log: 2.5.2.0 4118 0 27616 268 3 1 1095415 4096000 0 65024 0 0 n/a 0 0 http://s1asgc-cvmfs.openhtc.io:8080/cvmfs/cernvm-prod.cern.ch DIRECT 1
2023-11-21 04:12:46 (8332): Guest Log: Probing /cvmfs/alice.cern.ch... OK
2023-11-21 04:12:46 (8332): 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
2023-11-21 04:12:46 (8332): Guest Log: 2.5.2.0 4094 0 37588 17139 3 1 1095415 4096000 0 65024 0 0 n/a 4602 8059 http://s1cern-cvmfs.openhtc.io/cvmfs/alice.cern.ch DIRECT 1
2023-11-21 04:12:46 (8332): Guest Log: 12:14:37 CET +01:00 2023-11-20: cranky: [INFO] Checking runc.
2023-11-21 04:12:46 (8332): Guest Log: 12:14:37 CET +01:00 2023-11-20: cranky: [INFO] Creating the filesystem.
2023-11-21 04:12:46 (8332): Guest Log: 12:14:37 CET +01:00 2023-11-20: cranky: [INFO] Using /cvmfs/cernvm-prod.cern.ch/cvm3
2023-11-21 04:12:46 (8332): Guest Log: 12:14:37 CET +01:00 2023-11-20: cranky: [INFO] Updating config.json.
2023-11-21 04:12:46 (8332): Guest Log: 12:14:37 CET +01:00 2023-11-20: cranky: [INFO] Running Container 'runc'.
2023-11-21 04:12:46 (8332): Guest Log: job: htmld=/shared/html/job
2023-11-21 04:12:46 (8332): Guest Log: job: unpack exitcode=0
2023-11-21 04:12:46 (8332): Guest Log: 12:14:39 CET +01:00 2023-11-20: cranky: [INFO] ===> [runRivet] Mon Nov 20 11:14:38 UTC 2023 [boinc pp jets 13000 250,-,4760 - pythia8 8.301 cr1 100000 859]
2023-11-21 04:12:46 (8332): Starting VM using VBoxManage interface. (boinc_65fa58beaec03109, slot#1)
2023-11-21 04:12:52 (8332): Successfully started VM. (PID = '15852')
2023-11-21 04:12:52 (8332): Reporting VM Process ID to BOINC.
2023-11-21 04:12:52 (8332): VM state change detected. (old = 'poweredoff', new = 'running')
2023-11-21 04:12:52 (8332): Detected: Web Application Enabled (http://localhost:50277)
2023-11-21 04:12:52 (8332): Status Report: Job Duration: '864000.000000'
2023-11-21 04:12:52 (8332): Status Report: Elapsed Time: '129316.295529'
2023-11-21 04:12:52 (8332): Status Report: CPU Time: '113167.593750'
2023-11-21 04:12:52 (8332): Preference change detected
2023-11-21 04:12:52 (8332): Setting CPU throttle for VM. (100%)
2023-11-21 04:12:53 (8332): Setting checkpoint interval to 600 seconds. (Higher value of (Preference: 60 seconds) or (Vbox_job.xml: 600 seconds))
2023-11-21 04:43:40 (8332): Stopping VM.
2023-11-21 04:43:47 (8332): Successfully stopped VM.
2023-11-21 04:44:48 (23856): Detected: vboxwrapper 26206
2023-11-21 04:44:48 (23856): Detected: BOINC client v7.16.11
2023-11-21 04:44:49 (23856): Detected: VirtualBox VboxManage Interface (Version: 6.1.12)
2023-11-21 04:44:49 (23856): Detected: Heartbeat check (file: 'heartbeat' every 1200.000000 seconds)
2023-11-21 04:44:50 (23856): Starting VM using VBoxManage interface. (boinc_65fa58beaec03109, slot#1)
2023-11-21 04:45:06 (23856): Successfully started VM. (PID = '12912')
2023-11-21 04:45:06 (23856): Reporting VM Process ID to BOINC.
2023-11-21 04:45:06 (23856): VM state change detected. (old = 'poweredoff', new = 'running')
2023-11-21 04:45:06 (23856): Detected: Web Application Enabled (http://localhost:50277)
2023-11-21 04:45:06 (23856): Status Report: Job Duration: '864000.000000'
2023-11-21 04:45:06 (23856): Status Report: Elapsed Time: '131050.550868'
2023-11-21 04:45:06 (23856): Status Report: CPU Time: '114970.171875'
2023-11-21 04:45:06 (23856): Preference change detected
2023-11-21 04:45:06 (23856): Setting CPU throttle for VM. (100%)
2023-11-21 04:45:06 (23856): Setting checkpoint interval to 600 seconds. (Higher value of (Preference: 60 seconds) or (Vbox_job.xml: 600 seconds))
2023-11-21 05:05:52 (23856): Stopping VM.
2023-11-21 15:46:13 (12044): Detected: vboxwrapper 26206
2023-11-21 15:46:13 (12044): Detected: BOINC client v7.16.11
2023-11-21 15:46:23 (12044): Detected: VirtualBox VboxManage Interface (Version: 6.1.12)
2023-11-21 15:46:25 (12044): Detected: Heartbeat check (file: 'heartbeat' every 1200.000000 seconds)
2023-11-21 15:46:33 (12044): Starting VM using VBoxManage interface. (boinc_65fa58beaec03109, slot#1)
2023-11-21 15:46:39 (12044): Successfully started VM. (PID = '21360')
2023-11-21 15:46:39 (12044): Reporting VM Process ID to BOINC.
2023-11-21 15:46:39 (12044): Guest Log: BIOS: VirtualBox 6.1.12
2023-11-21 15:46:39 (12044): Guest Log: CPUID EDX: 0x178bfbff
2023-11-21 15:46:39 (12044): Guest Log: BIOS: No PCI IDE controller, not probing IDE
2023-11-21 15:46:39 (12044): Guest Log: BIOS: AHCI 0-P#0: PCHS=16383/16/63 LCHS=1024/255/63 0x0000000002800000 sectors
2023-11-21 15:46:39 (12044): VM state change detected. (old = 'poweredoff', new = 'running')
2023-11-21 15:46:39 (12044): Detected: Web Application Enabled (http://localhost:50277)
2023-11-21 15:46:39 (12044): Status Report: Job Duration: '864000.000000'
2023-11-21 15:46:39 (12044): Status Report: Elapsed Time: '132173.917970'
2023-11-21 15:46:39 (12044): Status Report: CPU Time: '116195.906250'
2023-11-21 15:46:39 (12044): Preference change detected
2023-11-21 15:46:39 (12044): Setting CPU throttle for VM. (100%)
2023-11-21 15:46:41 (12044): Setting checkpoint interval to 600 seconds. (Higher value of (Preference: 60 seconds) or (Vbox_job.xml: 600 seconds))
2023-11-21 15:46:41 (12044): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032
2023-11-21 15:46:41 (12044): Guest Log: BIOS: Booting from Hard Disk...
2023-11-21 15:46:42 (12044): Guest Log: BIOS: KBD: unsupported int 16h function 03
2023-11-21 15:46:42 (12044): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 
2023-11-21 15:47:07 (12044): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds
2023-11-21 15:47:07 (12044): Guest Log: vboxguest: misc device minor 56, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000)
2023-11-21 15:47:07 (12044): Guest Log: VBoxService 5.2.6 r120293 (verbosity: 0) linux.amd64 (Jan 15 2018 14:51:00) release log
2023-11-21 15:47:07 (12044): Guest Log: 00:00:00.000068 main     Log opened 2023-11-21T14:47:04.668922000Z
2023-11-21 15:47:07 (12044): Guest Log: 00:00:00.004223 main     OS Product: Linux
2023-11-21 15:47:07 (12044): Guest Log: 00:00:00.004464 main     OS Release: 4.14.76-13.cernvm.x86_64
2023-11-21 15:47:07 (12044): Guest Log: 00:00:00.004513 main     OS Version: #1 SMP Tue Oct 16 18:26:15 CEST 2018
2023-11-21 15:47:07 (12044): Guest Log: 00:00:00.004535 main     Executable: /usr/sbin/VBoxService
2023-11-21 15:47:07 (12044): Guest Log: 00:00:00.004536 main     Process ID: 3216
2023-11-21 15:47:07 (12044): Guest Log: 00:00:00.004536 main     Package type: LINUX_64BITS_GENERIC
2023-11-21 15:47:07 (12044): Guest Log: 00:00:00.006586 main     5.2.6 r120293 started. Verbose level = 0
2023-11-21 15:47:32 (12044): Guest Log: 15:47:31 CET +01:00 2023-11-21: cranky: [INFO] Detected Theory App
2023-11-21 15:47:32 (12044): Guest Log: 15:47:31 CET +01:00 2023-11-21: cranky: [INFO] Checking CVMFS.
2023-11-21 15:47:33 (12044): Guest Log: Probing /cvmfs/sft.cern.ch... OK
2023-11-21 15:47:33 (12044): 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
2023-11-21 15:47:33 (12044): Guest Log: 2.5.2.0 4074 0 28604 27658 3 1 1119541 4096000 0 65024 0 0 n/a 5 5 http://s1unl-cvmfs.openhtc.io/cvmfs/sft.cern.ch DIRECT 1
2023-11-21 15:47:34 (12044): Guest Log: Probing /cvmfs/grid.cern.ch... OK
2023-11-21 15:47:35 (12044): 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
2023-11-21 15:47:35 (12044): Guest Log: 2.5.2.0 4053 0 27448 22773 3 2 1119541 4096000 0 65024 0 2 0 5701 4388 http://s1bnl-cvmfs.openhtc.io/cvmfs/grid.cern.ch DIRECT 1
2023-11-21 15:47:36 (12044): Guest Log: Probing /cvmfs/cernvm-prod.cern.ch... OK
2023-11-21 15:47:36 (12044): 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
2023-11-21 15:47:36 (12044): Guest Log: 2.5.2.0 4123 0 25380 268 3 1 1119541 4096000 0 65024 0 0 n/a 0 0 http://s1bnl-cvmfs.openhtc.io/cvmfs/cernvm-prod.cern.ch DIRECT 1
2023-11-21 15:47:37 (12044): Guest Log: Probing /cvmfs/alice.cern.ch... OK
2023-11-21 15:47:38 (12044): 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
2023-11-21 15:47:38 (12044): Guest Log: 2.5.2.0 4099 0 37656 17150 3 1 1119541 4096000 0 65024 0 0 n/a 4665 8271 http://s1ral-cvmfs.openhtc.io/cvmfs/alice.cern.ch DIRECT 1
2023-11-21 15:47:38 (12044): Guest Log: 15:47:37 CET +01:00 2023-11-21: cranky: [INFO] Checking runc.
2023-11-21 15:47:38 (12044): Guest Log: 15:47:37 CET +01:00 2023-11-21: cranky: [INFO] Creating the filesystem.
2023-11-21 15:47:38 (12044): Guest Log: 15:47:37 CET +01:00 2023-11-21: cranky: [INFO] Using /cvmfs/cernvm-prod.cern.ch/cvm3
2023-11-21 15:47:39 (12044): Guest Log: 15:47:37 CET +01:00 2023-11-21: cranky: [INFO] Updating config.json.
2023-11-21 15:47:40 (12044): Guest Log: 15:47:37 CET +01:00 2023-11-21: cranky: [INFO] Running Container 'runc'.
2023-11-21 15:47:42 (12044): Guest Log: job: htmld=/shared/html/job
2023-11-21 15:47:42 (12044): Guest Log: job: unpack exitcode=0
2023-11-21 15:47:43 (12044): Guest Log: 15:47:39 CET +01:00 2023-11-21: cranky: [INFO] ===> [runRivet] Tue Nov 21 14:47:38 UTC 2023 [boinc pp jets 13000 250,-,4760 - pythia8 8.301 cr1 100000 859]
2023-11-21 16:13:13 (12044): Stopping VM.
2023-11-21 16:14:04 (12044): Error in stop VM for VM: -182
Command:
VBoxManage -q controlvm "boinc_65fa58beaec03109" savestate
Output:

2023-11-21 16:14:04 (12044): VM did not stop when requested.
2023-11-21 16:14:04 (12044): VM was successfully terminated.
2023-11-21 16:17:08 (1060): Detected: vboxwrapper 26206
2023-11-21 16:17:08 (1060): Detected: BOINC client v7.16.11
2023-11-21 16:17:09 (1060): Detected: VirtualBox VboxManage Interface (Version: 6.1.12)
2023-11-21 16:17:09 (1060): Detected: Heartbeat check (file: 'heartbeat' every 1200.000000 seconds)
2023-11-21 16:17:10 (1060): Guest Log: BIOS: VirtualBox 6.1.12
2023-11-21 16:17:10 (1060): Guest Log: CPUID EDX: 0x178bfbff
2023-11-21 16:17:10 (1060): Guest Log: BIOS: No PCI IDE controller, not probing IDE
2023-11-21 16:17:10 (1060): Guest Log: BIOS: AHCI 0-P#0: PCHS=16383/16/63 LCHS=1024/255/63 0x0000000002800000 sectors
2023-11-21 16:17:10 (1060): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032
2023-11-21 16:17:10 (1060): Guest Log: BIOS: Booting from Hard Disk...
2023-11-21 16:17:10 (1060): Guest Log: BIOS: KBD: unsupported int 16h function 03
2023-11-21 16:17:10 (1060): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 
2023-11-21 16:17:10 (1060): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds
2023-11-21 16:17:10 (1060): Guest Log: vboxguest: misc device minor 56, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000)
2023-11-21 16:17:10 (1060): Guest Log: VBoxService 5.2.6 r120293 (verbosity: 0) linux.amd64 (Jan 15 2018 14:51:00) release log
2023-11-21 16:17:10 (1060): Guest Log: 00:00:00.000068 main     Log opened 2023-11-21T14:47:04.668922000Z
2023-11-21 16:17:10 (1060): Guest Log: 00:00:00.004223 main     OS Product: Linux
2023-11-21 16:17:10 (1060): Guest Log: 00:00:00.004464 main     OS Release: 4.14.76-13.cernvm.x86_64
2023-11-21 16:17:10 (1060): Guest Log: 00:00:00.004513 main     OS Version: #1 SMP Tue Oct 16 18:26:15 CEST 2018
2023-11-21 16:17:10 (1060): Guest Log: 00:00:00.004535 main     Executable: /usr/sbin/VBoxService
2023-11-21 16:17:10 (1060): Guest Log: 00:00:00.004536 main     Process ID: 3216
2023-11-21 16:17:10 (1060): Guest Log: 00:00:00.004536 main     Package type: LINUX_64BITS_GENERIC
2023-11-21 16:17:10 (1060): Guest Log: 00:00:00.006586 main     5.2.6 r120293 started. Verbose level = 0
2023-11-21 16:17:10 (1060): Guest Log: 15:47:31 CET +01:00 2023-11-21: cranky: [INFO] Detected Theory App
2023-11-21 16:17:10 (1060): Guest Log: 15:47:31 CET +01:00 2023-11-21: cranky: [INFO] Checking CVMFS.
2023-11-21 16:17:10 (1060): Guest Log: Probing /cvmfs/sft.cern.ch... OK
2023-11-21 16:17:10 (1060): 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
2023-11-21 16:17:10 (1060): Guest Log: 2.5.2.0 4074 0 28604 27658 3 1 1119541 4096000 0 65024 0 0 n/a 5 5 http://s1unl-cvmfs.openhtc.io/cvmfs/sft.cern.ch DIRECT 1
2023-11-21 16:17:10 (1060): Guest Log: Probing /cvmfs/grid.cern.ch... OK
2023-11-21 16:17:10 (1060): 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
2023-11-21 16:17:10 (1060): Guest Log: 2.5.2.0 4053 0 27448 22773 3 2 1119541 4096000 0 65024 0 2 0 5701 4388 http://s1bnl-cvmfs.openhtc.io/cvmfs/grid.cern.ch DIRECT 1
2023-11-21 16:17:10 (1060): Guest Log: Probing /cvmfs/cernvm-prod.cern.ch... OK
2023-11-21 16:17:10 (1060): 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
2023-11-21 16:17:10 (1060): Guest Log: 2.5.2.0 4123 0 25380 268 3 1 1119541 4096000 0 65024 0 0 n/a 0 0 http://s1bnl-cvmfs.openhtc.io/cvmfs/cernvm-prod.cern.ch DIRECT 1
2023-11-21 16:17:10 (1060): Guest Log: Probing /cvmfs/alice.cern.ch... OK
2023-11-21 16:17:10 (1060): 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
2023-11-21 16:17:10 (1060): Guest Log: 2.5.2.0 4099 0 37656 17150 3 1 1119541 4096000 0 65024 0 0 n/a 4665 8271 http://s1ral-cvmfs.openhtc.io/cvmfs/alice.cern.ch DIRECT 1
2023-11-21 16:17:10 (1060): Guest Log: 15:47:37 CET +01:00 2023-11-21: cranky: [INFO] Checking runc.
2023-11-21 16:17:10 (1060): Guest Log: 15:47:37 CET +01:00 2023-11-21: cranky: [INFO] Creating the filesystem.
2023-11-21 16:17:10 (1060): Guest Log: 15:47:37 CET +01:00 2023-11-21: cranky: [INFO] Using /cvmfs/cernvm-prod.cern.ch/cvm3
2023-11-21 16:17:10 (1060): Guest Log: 15:47:37 CET +01:00 2023-11-21: cranky: [INFO] Updating config.json.
2023-11-21 16:17:10 (1060): Guest Log: 15:47:37 CET +01:00 2023-11-21: cranky: [INFO] Running Container 'runc'.
2023-11-21 16:17:10 (1060): Guest Log: job: htmld=/shared/html/job
2023-11-21 16:17:10 (1060): Guest Log: job: unpack exitcode=0
2023-11-21 16:17:10 (1060): Guest Log: 15:47:39 CET +01:00 2023-11-21: cranky: [INFO] ===> [runRivet] Tue Nov 21 14:47:38 UTC 2023 [boinc pp jets 13000 250,-,4760 - pythia8 8.301 cr1 100000 859]
2023-11-21 16:17:10 (1060): Starting VM using VBoxManage interface. (boinc_65fa58beaec03109, slot#1)
2023-11-21 16:17:14 (1060): Successfully started VM. (PID = '8500')
2023-11-21 16:17:14 (1060): Reporting VM Process ID to BOINC.
2023-11-21 16:17:14 (1060): Guest Log: BIOS: VirtualBox 6.1.12
2023-11-21 16:17:14 (1060): Guest Log: CPUID EDX: 0x178bfbff
2023-11-21 16:17:14 (1060): Guest Log: BIOS: No PCI IDE controller, not probing IDE
2023-11-21 16:17:14 (1060): Guest Log: BIOS: AHCI 0-P#0: PCHS=16383/16/63 LCHS=1024/255/63 0x0000000002800000 sectors
2023-11-21 16:17:14 (1060): VM state change detected. (old = 'poweredoff', new = 'running')
2023-11-21 16:17:14 (1060): Detected: Web Application Enabled (http://localhost:50277)
2023-11-21 16:17:14 (1060): Status Report: Job Duration: '864000.000000'
2023-11-21 16:17:14 (1060): Status Report: Elapsed Time: '133714.438367'
2023-11-21 16:17:14 (1060): Status Report: CPU Time: '117477.000000'
2023-11-21 16:17:14 (1060): Preference change detected
2023-11-21 16:17:14 (1060): Setting CPU throttle for VM. (100%)
2023-11-21 16:17:14 (1060): Setting checkpoint interval to 600 seconds. (Higher value of (Preference: 60 seconds) or (Vbox_job.xml: 600 seconds))
2023-11-21 16:17:16 (1060): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032
2023-11-21 16:17:16 (1060): Guest Log: BIOS: Booting from Hard Disk...
2023-11-21 16:17:20 (1060): Guest Log: BIOS: KBD: unsupported int 16h function 03
2023-11-21 16:17:20 (1060): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 
2023-11-21 16:17:35 (1060): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds
2023-11-21 16:17:35 (1060): Guest Log: vboxguest: misc device minor 56, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000)
2023-11-21 16:17:37 (1060): Guest Log: VBoxService 5.2.6 r120293 (verbosity: 0) linux.amd64 (Jan 15 2018 14:51:00) release log
2023-11-21 16:17:37 (1060): Guest Log: 00:00:00.000068 main     Log opened 2023-11-21T15:17:36.391488000Z
2023-11-21 16:17:37 (1060): Guest Log: 00:00:00.000208 main     OS Product: Linux
2023-11-21 16:17:37 (1060): Guest Log: 00:00:00.000248 main     OS Release: 4.14.76-13.cernvm.x86_64
2023-11-21 16:17:37 (1060): Guest Log: 00:00:00.000275 main     OS Version: #1 SMP Tue Oct 16 18:26:15 CEST 2018
2023-11-21 16:17:37 (1060): Guest Log: 00:00:00.000354 main     Executable: /usr/sbin/VBoxService
2023-11-21 16:17:37 (1060): Guest Log: 00:00:00.000354 main     Process ID: 3216
2023-11-21 16:17:37 (1060): Guest Log: 00:00:00.000355 main     Package type: LINUX_64BITS_GENERIC
2023-11-21 16:17:37 (1060): Guest Log: 00:00:00.003104 main     5.2.6 r120293 started. Verbose level = 0
2023-11-21 16:18:05 (1060): Guest Log: 16:17:58 CET +01:00 2023-11-21: cranky: [INFO] Detected Theory App
2023-11-21 16:18:05 (1060): Guest Log: 16:17:58 CET +01:00 2023-11-21: cranky: [INFO] Checking CVMFS.
2023-11-21 16:18:05 (1060): Guest Log: Probing /cvmfs/sft.cern.ch... OK
2023-11-21 16:18:05 (1060): 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
2023-11-21 16:18:05 (1060): Guest Log: 2.5.2.0 4074 0 25120 27658 3 1 1119559 4096000 0 65024 0 0 n/a 0 0 http://s1cern-cvmfs.openhtc.io/cvmfs/sft.cern.ch DIRECT 1
2023-11-21 16:18:05 (1060): Guest Log: Probing /cvmfs/grid.cern.ch... OK
2023-11-21 16:18:05 (1060): 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
2023-11-21 16:18:05 (1060): Guest Log: 2.5.2.0 4121 0 27620 22773 3 2 1119559 4096000 0 65024 0 2 100 0 0 http://s1bnl-cvmfs.openhtc.io/cvmfs/grid.cern.ch DIRECT 1
2023-11-21 16:18:05 (1060): Guest Log: Probing /cvmfs/cernvm-prod.cern.ch... OK
2023-11-21 16:18:05 (1060): 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
2023-11-21 16:18:05 (1060): Guest Log: 2.5.2.0 4100 0 25168 268 3 1 1119559 4096000 0 65024 0 0 n/a 0 0 http://s1asgc-cvmfs.openhtc.io:8080/cvmfs/cernvm-prod.cern.ch DIRECT 1
2023-11-21 16:18:05 (1060): Guest Log: Probing /cvmfs/alice.cern.ch... OK
2023-11-21 16:18:05 (1060): 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
2023-11-21 16:18:05 (1060): Guest Log: 2.5.2.0 4047 0 37548 17150 3 1 1119559 4096000 0 65024 0 0 n/a 0 0 http://s1asgc-cvmfs.openhtc.io:8080/cvmfs/alice.cern.ch DIRECT 1
2023-11-21 16:18:05 (1060): Guest Log: 16:18:03 CET +01:00 2023-11-21: cranky: [INFO] Checking runc.
2023-11-21 16:18:05 (1060): Guest Log: 16:18:03 CET +01:00 2023-11-21: cranky: [INFO] Creating the filesystem.
2023-11-21 16:18:05 (1060): Guest Log: 16:18:03 CET +01:00 2023-11-21: cranky: [INFO] Using /cvmfs/cernvm-prod.cern.ch/cvm3
2023-11-21 16:18:05 (1060): Guest Log: 16:18:03 CET +01:00 2023-11-21: cranky: [INFO] Updating config.json.
2023-11-21 16:18:05 (1060): Guest Log: 16:18:03 CET +01:00 2023-11-21: cranky: [INFO] Running Container 'runc'.
2023-11-21 16:18:05 (1060): Guest Log: job: htmld=/shared/html/job
2023-11-21 16:18:05 (1060): Guest Log: job: unpack exitcode=0
2023-11-21 16:18:06 (1060): Guest Log: 16:18:05 CET +01:00 2023-11-21: cranky: [INFO] ===> [runRivet] Tue Nov 21 15:18:03 UTC 2023 [boinc pp jets 13000 250,-,4760 - pythia8 8.301 cr1 100000 859]
2023-11-21 16:29:09 (1060): Stopping VM.
2023-11-21 16:29:45 (1060): Successfully stopped VM.
2023-11-21 16:30:50 (2436): Detected: vboxwrapper 26206
2023-11-21 16:30:50 (2436): Detected: BOINC client v7.16.11
2023-11-21 16:30:50 (2436): Detected: VirtualBox VboxManage Interface (Version: 6.1.12)
2023-11-21 16:30:51 (2436): Detected: Heartbeat check (file: 'heartbeat' every 1200.000000 seconds)
2023-11-21 16:30:52 (2436): Guest Log: BIOS: VirtualBox 6.1.12
2023-11-21 16:30:52 (2436): Guest Log: CPUID EDX: 0x178bfbff
2023-11-21 16:30:52 (2436): Guest Log: BIOS: No PCI IDE controller, not probing IDE
2023-11-21 16:30:52 (2436): Guest Log: BIOS: AHCI 0-P#0: PCHS=16383/16/63 LCHS=1024/255/63 0x0000000002800000 sectors
2023-11-21 16:30:52 (2436): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032
2023-11-21 16:30:52 (2436): Guest Log: BIOS: Booting from Hard Disk...
2023-11-21 16:30:52 (2436): Guest Log: BIOS: KBD: unsupported int 16h function 03
2023-11-21 16:30:52 (2436): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 
2023-11-21 16:30:52 (2436): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds
2023-11-21 16:30:52 (2436): Guest Log: vboxguest: misc device minor 56, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000)
2023-11-21 16:30:52 (2436): Guest Log: VBoxService 5.2.6 r120293 (verbosity: 0) linux.amd64 (Jan 15 2018 14:51:00) release log
2023-11-21 16:30:52 (2436): Guest Log: 00:00:00.000068 main     Log opened 2023-11-21T15:17:36.391488000Z
2023-11-21 16:30:52 (2436): Guest Log: 00:00:00.000208 main     OS Product: Linux
2023-11-21 16:30:52 (2436): Guest Log: 00:00:00.000248 main     OS Release: 4.14.76-13.cernvm.x86_64
2023-11-21 16:30:52 (2436): Guest Log: 00:00:00.000275 main     OS Version: #1 SMP Tue Oct 16 18:26:15 CEST 2018
2023-11-21 16:30:52 (2436): Guest Log: 00:00:00.000354 main     Executable: /usr/sbin/VBoxService
2023-11-21 16:30:52 (2436): Guest Log: 00:00:00.000354 main     Process ID: 3216
2023-11-21 16:30:52 (2436): Guest Log: 00:00:00.000355 main     Package type: LINUX_64BITS_GENERIC
2023-11-21 16:30:52 (2436): Guest Log: 00:00:00.003104 main     5.2.6 r120293 started. Verbose level = 0
2023-11-21 16:30:52 (2436): Guest Log: 16:17:58 CET +01:00 2023-11-21: cranky: [INFO] Detected Theory App
2023-11-21 16:30:52 (2436): Guest Log: 16:17:58 CET +01:00 2023-11-21: cranky: [INFO] Checking CVMFS.
2023-11-21 16:30:52 (2436): Guest Log: Probing /cvmfs/sft.cern.ch... OK
2023-11-21 16:30:52 (2436): 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
2023-11-21 16:30:52 (2436): Guest Log: 2.5.2.0 4074 0 25120 27658 3 1 1119559 4096000 0 65024 0 0 n/a 0 0 http://s1cern-cvmfs.openhtc.io/cvmfs/sft.cern.ch DIRECT 1
2023-11-21 16:30:52 (2436): Guest Log: Probing /cvmfs/grid.cern.ch... OK
2023-11-21 16:30:52 (2436): 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
2023-11-21 16:30:52 (2436): Guest Log: 2.5.2.0 4121 0 27620 22773 3 2 1119559 4096000 0 65024 0 2 100 0 0 http://s1bnl-cvmfs.openhtc.io/cvmfs/grid.cern.ch DIRECT 1
2023-11-21 16:30:52 (2436): Guest Log: Probing /cvmfs/cernvm-prod.cern.ch... OK
2023-11-21 16:30:52 (2436): 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
2023-11-21 16:30:52 (2436): Guest Log: 2.5.2.0 4100 0 25168 268 3 1 1119559 4096000 0 65024 0 0 n/a 0 0 http://s1asgc-cvmfs.openhtc.io:8080/cvmfs/cernvm-prod.cern.ch DIRECT 1
2023-11-21 16:30:52 (2436): Guest Log: Probing /cvmfs/alice.cern.ch... OK
2023-11-21 16:30:52 (2436): 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
2023-11-21 16:30:52 (2436): Guest Log: 2.5.2.0 4047 0 37548 17150 3 1 1119559 4096000 0 65024 0 0 n/a 0 0 http://s1asgc-cvmfs.openhtc.io:8080/cvmfs/alice.cern.ch DIRECT 1
2023-11-21 16:30:52 (2436): Guest Log: 16:18:03 CET +01:00 2023-11-21: cranky: [INFO] Checking runc.
2023-11-21 16:30:52 (2436): Guest Log: 16:18:03 CET +01:00 2023-11-21: cranky: [INFO] Creating the filesystem.
2023-11-21 16:30:52 (2436): Guest Log: 16:18:03 CET +01:00 2023-11-21: cranky: [INFO] Using /cvmfs/cernvm-prod.cern.ch/cvm3
2023-11-21 16:30:52 (2436): Guest Log: 16:18:03 CET +01:00 2023-11-21: cranky: [INFO] Updating config.json.
2023-11-21 16:30:52 (2436): Guest Log: 16:18:03 CET +01:00 2023-11-21: cranky: [INFO] Running Container 'runc'.
2023-11-21 16:30:52 (2436): Guest Log: job: htmld=/shared/html/job
2023-11-21 16:30:52 (2436): Guest Log: job: unpack exitcode=0
2023-11-21 16:30:52 (2436): Guest Log: 16:18:05 CET +01:00 2023-11-21: cranky: [INFO] ===> [runRivet] Tue Nov 21 15:18:03 UTC 2023 [boinc pp jets 13000 250,-,4760 - pythia8 8.301 cr1 100000 859]
2023-11-21 16:30:52 (2436): Starting VM using VBoxManage interface. (boinc_65fa58beaec03109, slot#1)
2023-11-21 16:31:27 (2436): Successfully started VM. (PID = '21508')
2023-11-21 16:31:27 (2436): Reporting VM Process ID to BOINC.
2023-11-21 16:31:27 (2436): VM state change detected. (old = 'poweredoff', new = 'running')
2023-11-21 16:31:27 (2436): Detected: Web Application Enabled (http://localhost:50277)
2023-11-21 16:31:27 (2436): Status Report: Job Duration: '864000.000000'
2023-11-21 16:31:27 (2436): Status Report: Elapsed Time: '134332.957210'
2023-11-21 16:31:27 (2436): Status Report: CPU Time: '118129.890625'
2023-11-21 16:31:27 (2436): Preference change detected
2023-11-21 16:31:27 (2436): Setting CPU throttle for VM. (100%)
2023-11-21 16:33:29 (2436): Setting checkpoint interval to 600 seconds. (Higher value of (Preference: 60 seconds) or (Vbox_job.xml: 600 seconds))
2023-11-21 18:30:24 (2436): Status Report: Job Duration: '864000.000000'
2023-11-21 18:30:24 (2436): Status Report: Elapsed Time: '140333.226808'
2023-11-21 18:30:24 (2436): Status Report: CPU Time: '125252.078125'
2023-11-21 20:29:13 (2436): Status Report: Job Duration: '864000.000000'
2023-11-21 20:29:13 (2436): Status Report: Elapsed Time: '146333.226808'
2023-11-21 20:29:13 (2436): Status Report: CPU Time: '132335.515625'
2023-11-21 22:43:04 (2436): Status Report: Job Duration: '864000.000000'
2023-11-21 22:43:04 (2436): Status Report: Elapsed Time: '152333.226808'
2023-11-21 22:43:04 (2436): Status Report: CPU Time: '140314.359375'
2023-11-22 01:01:00 (2436): Status Report: Job Duration: '864000.000000'
2023-11-22 01:01:00 (2436): Status Report: Elapsed Time: '158333.226808'
2023-11-22 01:01:00 (2436): Status Report: CPU Time: '148538.546875'
2023-11-22 03:14:16 (2436): Status Report: Job Duration: '864000.000000'
2023-11-22 03:14:16 (2436): Status Report: Elapsed Time: '164333.226808'
2023-11-22 03:14:16 (2436): Status Report: CPU Time: '156482.953125'
2023-11-22 04:11:20 (2436): Stopping VM.
2023-11-22 04:11:22 (2436): Successfully stopped VM.
2023-11-22 12:51:40 (23540): Detected: vboxwrapper 26206
2023-11-22 12:51:40 (23540): Detected: BOINC client v7.16.11
2023-11-22 12:51:41 (23540): Detected: VirtualBox VboxManage Interface (Version: 6.1.12)
2023-11-22 12:51:42 (23540): Detected: Heartbeat check (file: 'heartbeat' every 1200.000000 seconds)
2023-11-22 12:51:44 (23540): Starting VM using VBoxManage interface. (boinc_65fa58beaec03109, slot#1)
2023-11-22 12:51:50 (23540): Successfully started VM. (PID = '14660')
2023-11-22 12:51:50 (23540): Reporting VM Process ID to BOINC.
2023-11-22 12:51:50 (23540): Guest Log: 11:52:31.228191 timesync vgsvcTimeSyncWorker: Radical host time change: 31 237 921 000 000ns (HostNow=1 700 653 909 036 000 000 ns HostLast=1 700 622 671 115 000 000 ns)
2023-11-22 12:51:50 (23540): VM state change detected. (old = 'poweredoff', new = 'running')
2023-11-22 12:51:50 (23540): Detected: Web Application Enabled (http://localhost:50277)
2023-11-22 12:51:50 (23540): Status Report: Job Duration: '864000.000000'
2023-11-22 12:51:50 (23540): Status Report: Elapsed Time: '167104.226808'
2023-11-22 12:51:50 (23540): Status Report: CPU Time: '159883.953125'
2023-11-22 12:51:50 (23540): Preference change detected
2023-11-22 12:51:50 (23540): Setting CPU throttle for VM. (100%)
2023-11-22 12:51:50 (23540): Setting checkpoint interval to 600 seconds. (Higher value of (Preference: 60 seconds) or (Vbox_job.xml: 600 seconds))
2023-11-22 12:51:59 (23540): Guest Log: 11:52:41.265411 timesync vgsvcTimeSyncWorker: Radical guest time change: 31 237 882 491 000ns (GuestNow=1 700 653 919 105 964 000 ns GuestLast=1 700 622 681 223 473 000 ns fSetTimeLastLoop=true )
2023-11-22 14:40:52 (23540): Status Report: Job Duration: '864000.000000'
2023-11-22 14:40:52 (23540): Status Report: Elapsed Time: '173104.226808'
2023-11-22 14:40:52 (23540): Status Report: CPU Time: '166383.171875'
2023-11-22 16:33:57 (23540): Status Report: Job Duration: '864000.000000'
2023-11-22 16:33:57 (23540): Status Report: Elapsed Time: '179104.226808'
2023-11-22 16:33:57 (23540): Status Report: CPU Time: '173116.703125'
2023-11-22 18:20:43 (23540): Status Report: Job Duration: '864000.000000'
2023-11-22 18:20:43 (23540): Status Report: Elapsed Time: '185104.226808'
2023-11-22 18:20:43 (23540): Status Report: CPU Time: '179475.515625'
2023-11-22 20:09:17 (23540): Status Report: Job Duration: '864000.000000'
2023-11-22 20:09:17 (23540): Status Report: Elapsed Time: '191104.226808'
2023-11-22 20:09:17 (23540): Status Report: CPU Time: '185930.734375'
2023-11-22 21:59:45 (23540): Status Report: Job Duration: '864000.000000'
2023-11-22 21:59:45 (23540): Status Report: Elapsed Time: '197104.226808'
2023-11-22 21:59:45 (23540): Status Report: CPU Time: '192504.593750'
2023-11-22 23:50:25 (23540): Status Report: Job Duration: '864000.000000'
2023-11-22 23:50:25 (23540): Status Report: Elapsed Time: '203104.226808'
2023-11-22 23:50:25 (23540): Status Report: CPU Time: '199097.640625'
2023-11-23 01:41:48 (23540): Status Report: Job Duration: '864000.000000'
2023-11-23 01:41:48 (23540): Status Report: Elapsed Time: '209104.226808'
2023-11-23 01:41:48 (23540): Status Report: CPU Time: '205733.234375'
2023-11-23 03:32:00 (23540): Status Report: Job Duration: '864000.000000'
2023-11-23 03:32:00 (23540): Status Report: Elapsed Time: '215104.226808'
2023-11-23 03:32:00 (23540): Status Report: CPU Time: '212296.265625'
2023-11-23 04:33:26 (23540): Stopping VM.
2023-11-23 04:33:28 (23540): Successfully stopped VM.
2023-11-23 15:50:58 (18452): Detected: vboxwrapper 26206
2023-11-23 15:50:58 (18452): Detected: BOINC client v7.16.11
2023-11-23 15:51:11 (18452): Detected: VirtualBox VboxManage Interface (Version: 6.1.12)
2023-11-23 15:51:23 (18452): Detected: Heartbeat check (file: 'heartbeat' every 1200.000000 seconds)
2023-11-23 15:51:34 (18452): Guest Log: 11:52:31.228191 timesync vgsvcTimeSyncWorker: Radical host time change: 31 237 921 000 000ns (HostNow=1 700 653 909 036 000 000 ns HostLast=1 700 622 671 115 000 000 ns)
2023-11-23 15:51:34 (18452): Guest Log: 11:52:41.265411 timesync vgsvcTimeSyncWorker: Radical guest time change: 31 237 882 491 000ns (GuestNow=1 700 653 919 105 964 000 ns GuestLast=1 700 622 681 223 473 000 ns fSetTimeLastLoop=true )
2023-11-23 15:51:34 (18452): Starting VM using VBoxManage interface. (boinc_65fa58beaec03109, slot#1)
2023-11-23 15:52:09 (18452): Successfully started VM. (PID = '15700')
2023-11-23 15:52:09 (18452): Reporting VM Process ID to BOINC.
2023-11-23 15:52:09 (18452): Guest Log: 27:34:16.036358 timesync vgsvcTimeSyncWorker: Radical host time change: 40 708 634 000 000ns (HostNow=1 700 751 112 510 000 000 ns HostLast=1 700 710 403 876 000 000 ns)
2023-11-23 15:52:09 (18452): Guest Log: 27:34:26.040435 timesync vgsvcTimeSyncWorker: Radical guest time change: 40 708 637 486 000ns (GuestNow=1 700 751 122 514 233 000 ns GuestLast=1 700 710 413 876 747 000 ns fSetTimeLastLoop=true )
2023-11-23 15:52:09 (18452): VM state change detected. (old = 'poweredoff', new = 'running')
2023-11-23 15:52:09 (18452): Detected: Web Application Enabled (http://localhost:50277)
2023-11-23 15:52:09 (18452): Status Report: Job Duration: '864000.000000'
2023-11-23 15:52:10 (18452): Status Report: Elapsed Time: '218542.226808'
2023-11-23 15:52:10 (18452): Status Report: CPU Time: '215945.218750'
2023-11-23 15:52:10 (18452): Preference change detected
2023-11-23 15:52:10 (18452): Setting CPU throttle for VM. (100%)
2023-11-23 15:52:11 (18452): Setting checkpoint interval to 600 seconds. (Higher value of (Preference: 60 seconds) or (Vbox_job.xml: 600 seconds))
2023-11-23 16:55:32 (18452): Guest Log: job: run exitcode=0
2023-11-23 16:55:32 (18452): Guest Log: job: diskusage=2496
2023-11-23 16:55:32 (18452): Guest Log: job: logsize=68 k
2023-11-23 16:55:32 (18452): Guest Log: job: times=
2023-11-23 16:55:32 (18452): Guest Log: 0m0.002s 0m0.008s
2023-11-23 16:55:32 (18452): Guest Log: 1706m52.340s 4m17.997s
2023-11-23 16:55:32 (18452): Guest Log: job: cpuusage=102670
2023-11-23 16:55:32 (18452): Guest Log: 16:55:32 CET +01:00 2023-11-23: cranky: [INFO] Container 'runc' finished with status code 0.
2023-11-23 16:55:32 (18452): Guest Log: 16:55:32 CET +01:00 2023-11-23: cranky: [INFO] Preparing output.
2023-11-23 16:55:33 (18452): Guest Log: [INFO] Job Finished
2023-11-23 16:55:33 (18452): Guest Log: [INFO] Shutting Down.
2023-11-23 16:55:33 (18452): VM Completion File Detected.
2023-11-23 16:55:33 (18452): VM Completion Message: Job Finished
.
2023-11-23 16:55:33 (18452): Powering off VM.
2023-11-23 16:55:35 (18452): Successfully stopped VM.
2023-11-23 16:55:35 (18452): Deregistering VM. (boinc_65fa58beaec03109, slot#1)
2023-11-23 16:55:36 (18452): Removing network bandwidth throttle group from VM.
2023-11-23 16:55:37 (18452): Removing VM from VirtualBox.
16:55:43 (18452): called boinc_finish(0)

</stderr_txt>
]]>
LHC@home

Stderr output
