| Name | Theory_2743-2723729-406_0 |
| Workunit | 225166417 |
| Created | 30 Aug 2024, 18:01:45 UTC |
| Sent | 31 Aug 2024, 16:55:34 UTC |
| Report deadline | 11 Sep 2024, 16:55:34 UTC |
| Received | 12 Sep 2024, 21:44:23 UTC |
| Server state | Over |
| Outcome | Success |
| Client state | Done |
| Exit status | 0 (0x00000000) |
| Computer ID | 10840962 |
| Run time | 1 days 22 hours 3 min 15 sec |
| CPU time | 1 days 10 hours 53 min 15 sec |
| Validate state | Valid |
| Credit | 1,452.59 |
| Device peak FLOPS | 3.78 GFLOPS |
| Application version | Theory Simulation v300.30 (vbox64_theory) windows_x86_64 |
| Peak working set size | 89.00 MB |
| Peak swap size | 81.33 MB |
| Peak disk usage | 1.51 GB |
Stderr output
<core_client_version>8.0.2</core_client_version> <![CDATA[ <stderr_txt> 2024-09-03 13:18:15 (31872): vboxwrapper version 26207 2024-09-03 13:18:15 (31872): BOINC client version: 8.0.2 2024-09-03 13:18:16 (31872): Detected: VirtualBox VboxManage Interface (Version: 7.0.20) 2024-09-03 13:18:16 (31872): Detected: Heartbeat check (file: 'heartbeat' every 1200.000000 seconds) 2024-09-03 13:18:16 (31872): Successfully copied 'init_data.xml' to the shared directory. 2024-09-03 13:18:16 (31872): Successfully copied 'input' to the shared directory. 2024-09-03 13:18:17 (31872): Create VM. (boinc_0d3bb89ff12b6e8c, slot#16) 2024-09-03 13:18:17 (31872): Setting Memory Size for VM. (630MB) 2024-09-03 13:18:17 (31872): Setting CPU Count for VM. (1) 2024-09-03 13:18:18 (31872): Setting Chipset Options for VM. 2024-09-03 13:18:18 (31872): Setting Graphics Controller Options for VM. 2024-09-03 13:18:18 (31872): Setting Boot Options for VM. 2024-09-03 13:18:18 (31872): Setting Network Configuration for NAT. 2024-09-03 13:18:19 (31872): Enabling VM Network Access. 2024-09-03 13:18:19 (31872): Disabling USB Support for VM. 2024-09-03 13:18:19 (31872): Disabling COM Port Support for VM. 2024-09-03 13:18:19 (31872): Disabling LPT Port Support for VM. 2024-09-03 13:18:20 (31872): Disabling Audio Support for VM. 2024-09-03 13:18:20 (31872): Disabling Clipboard Support for VM. 2024-09-03 13:18:20 (31872): Disabling Drag and Drop Support for VM. 2024-09-03 13:18:20 (31872): Adding storage controller(s) to VM. 2024-09-03 13:18:21 (31872): Adding virtual disk drive to VM. (Theory_2024_04_30_prod.vdi) 2024-09-03 13:18:21 (31872): Adding VirtualBox Guest Additions to VM. 2024-09-03 13:18:21 (31872): Adding network bandwidth throttle group to VM. (Defaulting to 1024GB) 2024-09-03 13:18:22 (31872): forwarding host port 55448 to guest port 80 2024-09-03 13:18:22 (31872): Enabling remote desktop for VM. 2024-09-03 13:18:22 (31872): Required extension pack not installed, remote desktop not enabled. 2024-09-03 13:18:22 (31872): Enabling shared directory for VM. 2024-09-03 13:18:23 (31872): Starting VM using VBoxManage interface. (boinc_0d3bb89ff12b6e8c, slot#16) 2024-09-03 13:18:31 (31872): Successfully started VM. (PID = '8980') 2024-09-03 13:18:31 (31872): Reporting VM Process ID to BOINC. 2024-09-03 13:18:31 (31872): Guest Log: BIOS: VirtualBox 7.0.20 2024-09-03 13:18:31 (31872): Guest Log: CPUID EDX: 0x178bfbff 2024-09-03 13:18:31 (31872): Guest Log: BIOS: No PCI IDE controller, not probing IDE 2024-09-03 13:18:31 (31872): Guest Log: BIOS: AHCI 0-P#0: PCHS=16383/16/63 LCHS=1024/255/63 0x0000000002800000 sectors 2024-09-03 13:18:31 (31872): VM state change detected. (old = 'poweredoff', new = 'running') 2024-09-03 13:18:31 (31872): Detected: Web Application Enabled (http://localhost:55448) 2024-09-03 13:18:31 (31872): Preference change detected 2024-09-03 13:18:31 (31872): Setting CPU throttle for VM. (70%) 2024-09-03 13:18:32 (31872): Setting checkpoint interval to 600 seconds. (Higher value of (Preference: 60 seconds) or (Vbox_job.xml: 600 seconds)) 2024-09-03 13:18:33 (31872): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032 2024-09-03 13:18:33 (31872): Guest Log: BIOS: Booting from Hard Disk... 2024-09-03 13:18:36 (31872): Guest Log: BIOS: KBD: unsupported int 16h function 03 2024-09-03 13:18:36 (31872): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 2024-09-03 13:18:57 (31872): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds 2024-09-03 13:18:57 (31872): Guest Log: vboxguest: misc device minor 56, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000) 2024-09-03 13:19:02 (31872): Guest Log: VBoxService 5.2.6 r120293 (verbosity: 0) linux.amd64 (Jan 15 2018 14:51:00) release log 2024-09-03 13:19:02 (31872): Guest Log: 00:00:00.000149 main Log opened 2024-09-03T18:19:02.102608000Z 2024-09-03 13:19:02 (31872): Guest Log: 00:00:00.000322 main OS Product: Linux 2024-09-03 13:19:02 (31872): Guest Log: 00:00:00.000384 main OS Release: 4.14.76-13.cernvm.x86_64 2024-09-03 13:19:02 (31872): Guest Log: 00:00:00.000416 main OS Version: #1 SMP Tue Oct 16 18:26:15 CEST 2018 2024-09-03 13:19:02 (31872): Guest Log: 00:00:00.000459 main Executable: /usr/sbin/VBoxService 2024-09-03 13:19:02 (31872): Guest Log: 00:00:00.000460 main Process ID: 3226 2024-09-03 13:19:02 (31872): Guest Log: 00:00:00.000461 main Package type: LINUX_64BITS_GENERIC 2024-09-03 13:19:02 (31872): Guest Log: 00:00:00.003498 main 5.2.6 r120293 started. Verbose level = 0 2024-09-03 13:19:33 (31872): Guest Log: 20:19:33 CEST +02:00 2024-09-03: cranky: [INFO] Detected Theory App 2024-09-03 13:19:33 (31872): Guest Log: 20:19:33 CEST +02:00 2024-09-03: cranky: [INFO] Checking CVMFS. 2024-09-03 13:19:35 (31872): Guest Log: Probing /cvmfs/sft.cern.ch... OK 2024-09-03 13:19:35 (31872): 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-09-03 13:19:35 (31872): Guest Log: 2.5.2.0 4086 0 27212 30377 3 1 273020 4096000 0 65024 0 0 n/a 5 7 http://s1bnl-cvmfs.openhtc.io/cvmfs/sft.cern.ch DIRECT 1 2024-09-03 13:19:37 (31872): Guest Log: Probing /cvmfs/grid.cern.ch... OK 2024-09-03 13:19:37 (31872): 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-09-03 13:19:37 (31872): Guest Log: 2.5.2.0 4064 0 27524 25137 3 2 273020 4096000 0 65024 0 2 -100 7967 3216 http://s1unl-cvmfs.openhtc.io/cvmfs/grid.cern.ch DIRECT 1 2024-09-03 13:19:39 (31872): Guest Log: Probing /cvmfs/cernvm-prod.cern.ch... OK 2024-09-03 13:19:39 (31872): 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-09-03 13:19:39 (31872): Guest Log: 2.5.2.0 4139 0 25172 272 3 1 273020 4096000 0 65024 0 0 n/a 4 0 http://s1unl-cvmfs.openhtc.io/cvmfs/cernvm-prod.cern.ch DIRECT 1 2024-09-03 13:19:41 (31872): Guest Log: Probing /cvmfs/alice.cern.ch... OK 2024-09-03 13:19:41 (31872): 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-09-03 13:19:41 (31872): Guest Log: 2.5.2.0 4109 0 38636 19571 3 1 273020 4096000 0 65024 0 0 n/a 5799 2371 http://s1ihep-cvmfs.openhtc.io/cvmfs/alice.cern.ch DIRECT 1 2024-09-03 13:19:41 (31872): Guest Log: 20:19:41 CEST +02:00 2024-09-03: cranky: [INFO] Checking runc. 2024-09-03 13:19:41 (31872): Guest Log: 20:19:41 CEST +02:00 2024-09-03: cranky: [INFO] Creating the filesystem. 2024-09-03 13:19:41 (31872): Guest Log: 20:19:41 CEST +02:00 2024-09-03: cranky: [INFO] Using /cvmfs/cernvm-prod.cern.ch/cvm4 2024-09-03 13:19:41 (31872): Guest Log: 20:19:41 CEST +02:00 2024-09-03: cranky: [INFO] Updating config.json. 2024-09-03 13:19:42 (31872): Guest Log: 20:19:41 CEST +02:00 2024-09-03: cranky: [INFO] Running Container 'runc'. 2024-09-03 13:19:44 (31872): Guest Log: job: htmld=/shared/html/job 2024-09-03 13:19:44 (31872): Guest Log: job: unpack exitcode=0 2024-09-03 13:19:44 (31872): Guest Log: INFO: activated the work-around for ld: 2024-09-03 13:19:44 (31872): Guest Log: lrwxrwxrwx 1 0 0 15 Sep 3 18:19 /tmp/tmp.1ZssbhFgnL/ld -> /usr/bin/ld.bfd 2024-09-03 13:19:46 (31872): Guest Log: 20:19:46 CEST +02:00 2024-09-03: cranky: [INFO] ===> [runRivet] Tue Sep 3 18:19:44 UTC 2024 [boinc pp jets 13000 180 - pythia8 8.244 tune-A2m 100000 406] 2024-09-03 13:20:07 (31872): VM state change detected. (old = 'running', new = 'paused') 2024-09-03 13:20:27 (31872): VM state change detected. (old = 'paused', new = 'running') 2024-09-03 14:22:25 (31872): VM state change detected. (old = 'running', new = 'paused') 2024-09-06 13:50:30 (31872): Stopping VM. 2024-09-06 13:50:46 (31872): Successfully stopped VM. 2024-09-10 17:36:43 (25244): vboxwrapper version 26207 2024-09-10 17:36:43 (25244): BOINC client version: 8.0.2 2024-09-10 17:36:45 (25244): Detected: VirtualBox VboxManage Interface (Version: 7.0.20) 2024-09-10 17:36:45 (25244): Detected: Heartbeat check (file: 'heartbeat' every 1200.000000 seconds) 2024-09-10 17:36:46 (25244): Guest Log: BIOS: VirtualBox 7.0.20 2024-09-10 17:36:46 (25244): Guest Log: CPUID EDX: 0x178bfbff 2024-09-10 17:36:46 (25244): Guest Log: BIOS: No PCI IDE controller, not probing IDE 2024-09-10 17:36:46 (25244): Guest Log: BIOS: AHCI 0-P#0: PCHS=16383/16/63 LCHS=1024/255/63 0x0000000002800000 sectors 2024-09-10 17:36:46 (25244): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032 2024-09-10 17:36:46 (25244): Guest Log: BIOS: Booting from Hard Disk... 2024-09-10 17:36:46 (25244): Guest Log: BIOS: KBD: unsupported int 16h function 03 2024-09-10 17:36:46 (25244): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 2024-09-10 17:36:46 (25244): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds 2024-09-10 17:36:46 (25244): Guest Log: vboxguest: misc device minor 56, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000) 2024-09-10 17:36:46 (25244): Guest Log: VBoxService 5.2.6 r120293 (verbosity: 0) linux.amd64 (Jan 15 2018 14:51:00) release log 2024-09-10 17:36:46 (25244): Guest Log: 00:00:00.000149 main Log opened 2024-09-03T18:19:02.102608000Z 2024-09-10 17:36:46 (25244): Guest Log: 00:00:00.000322 main OS Product: Linux 2024-09-10 17:36:46 (25244): Guest Log: 00:00:00.000384 main OS Release: 4.14.76-13.cernvm.x86_64 2024-09-10 17:36:46 (25244): Guest Log: 00:00:00.000416 main OS Version: #1 SMP Tue Oct 16 18:26:15 CEST 2018 2024-09-10 17:36:46 (25244): Guest Log: 00:00:00.000459 main Executable: /usr/sbin/VBoxService 2024-09-10 17:36:46 (25244): Guest Log: 00:00:00.000460 main Process ID: 3226 2024-09-10 17:36:46 (25244): Guest Log: 00:00:00.000461 main Package type: LINUX_64BITS_GENERIC 2024-09-10 17:36:46 (25244): Guest Log: 00:00:00.003498 main 5.2.6 r120293 started. Verbose level = 0 2024-09-10 17:36:46 (25244): Guest Log: 20:19:33 CEST +02:00 2024-09-03: cranky: [INFO] Detected Theory App 2024-09-10 17:36:46 (25244): Guest Log: 20:19:33 CEST +02:00 2024-09-03: cranky: [INFO] Checking CVMFS. 2024-09-10 17:36:46 (25244): Guest Log: Probing /cvmfs/sft.cern.ch... OK 2024-09-10 17:36:46 (25244): 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-09-10 17:36:46 (25244): Guest Log: 2.5.2.0 4086 0 27212 30377 3 1 273020 4096000 0 65024 0 0 n/a 5 7 http://s1bnl-cvmfs.openhtc.io/cvmfs/sft.cern.ch DIRECT 1 2024-09-10 17:36:46 (25244): Guest Log: Probing /cvmfs/grid.cern.ch... OK 2024-09-10 17:36:46 (25244): 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-09-10 17:36:46 (25244): Guest Log: 2.5.2.0 4064 0 27524 25137 3 2 273020 4096000 0 65024 0 2 -100 7967 3216 http://s1unl-cvmfs.openhtc.io/cvmfs/grid.cern.ch DIRECT 1 2024-09-10 17:36:46 (25244): Guest Log: Probing /cvmfs/cernvm-prod.cern.ch... OK 2024-09-10 17:36:46 (25244): 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-09-10 17:36:46 (25244): Guest Log: 2.5.2.0 4139 0 25172 272 3 1 273020 4096000 0 65024 0 0 n/a 4 0 http://s1unl-cvmfs.openhtc.io/cvmfs/cernvm-prod.cern.ch DIRECT 1 2024-09-10 17:36:46 (25244): Guest Log: Probing /cvmfs/alice.cern.ch... OK 2024-09-10 17:36:46 (25244): 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-09-10 17:36:46 (25244): Guest Log: 2.5.2.0 4109 0 38636 19571 3 1 273020 4096000 0 65024 0 0 n/a 5799 2371 http://s1ihep-cvmfs.openhtc.io/cvmfs/alice.cern.ch DIRECT 1 2024-09-10 17:36:46 (25244): Guest Log: 20:19:41 CEST +02:00 2024-09-03: cranky: [INFO] Checking runc. 2024-09-10 17:36:46 (25244): Guest Log: 20:19:41 CEST +02:00 2024-09-03: cranky: [INFO] Creating the filesystem. 2024-09-10 17:36:46 (25244): Guest Log: 20:19:41 CEST +02:00 2024-09-03: cranky: [INFO] Using /cvmfs/cernvm-prod.cern.ch/cvm4 2024-09-10 17:36:46 (25244): Guest Log: 20:19:41 CEST +02:00 2024-09-03: cranky: [INFO] Updating config.json. 2024-09-10 17:36:46 (25244): Guest Log: 20:19:41 CEST +02:00 2024-09-03: cranky: [INFO] Running Container 'runc'. 2024-09-10 17:36:46 (25244): Guest Log: job: htmld=/shared/html/job 2024-09-10 17:36:46 (25244): Guest Log: job: unpack exitcode=0 2024-09-10 17:36:46 (25244): Guest Log: INFO: activated the work-around for ld: 2024-09-10 17:36:46 (25244): Guest Log: lrwxrwxrwx 1 0 0 15 Sep 3 18:19 /tmp/tmp.1ZssbhFgnL/ld -> /usr/bin/ld.bfd 2024-09-10 17:36:46 (25244): Guest Log: 20:19:46 CEST +02:00 2024-09-03: cranky: [INFO] ===> [runRivet] Tue Sep 3 18:19:44 UTC 2024 [boinc pp jets 13000 180 - pythia8 8.244 tune-A2m 100000 406] 2024-09-10 17:36:46 (25244): Starting VM using VBoxManage interface. (boinc_0d3bb89ff12b6e8c, slot#16) 2024-09-10 17:37:01 (25244): Successfully started VM. (PID = '30168') 2024-09-10 17:37:01 (25244): Reporting VM Process ID to BOINC. 2024-09-10 17:37:01 (25244): VM state change detected. (old = 'poweredoff', new = 'running') 2024-09-10 17:37:01 (25244): Detected: Web Application Enabled (http://localhost:55448) 2024-09-10 17:37:02 (25244): VM state change detected. (old = 'running', new = 'paused') 2024-09-10 17:37:08 (25244): Preference change detected 2024-09-10 17:37:08 (25244): Setting CPU throttle for VM. (70%) 2024-09-10 17:37:08 (25244): Setting checkpoint interval to 600 seconds. (Higher value of (Preference: 60 seconds) or (Vbox_job.xml: 600 seconds)) 2024-09-10 17:37:09 (25244): VM state change detected. (old = 'paused', new = 'running') 2024-09-10 17:37:10 (25244): Guest Log: 01:03:07.191503 timesync vgsvcTimeSyncWorker: Radical host time change: 616 492 483 000 000ns (HostNow=1 726 007 829 115 000 000 ns HostLast=1 725 391 336 632 000 000 ns) 2024-09-10 17:37:20 (25244): Guest Log: 01:03:17.216250 timesync vgsvcTimeSyncWorker: Radical guest time change: 616 509 890 276 000ns (GuestNow=1 726 007 839 143 328 000 ns GuestLast=1 725 391 329 253 052 000 ns fSetTimeLastLoop=true ) 2024-09-10 18:13:42 (25244): Status Report: Job Duration: '864000.000000' 2024-09-10 18:13:42 (25244): Status Report: Elapsed Time: '6000.000000' 2024-09-10 18:13:42 (25244): Status Report: CPU Time: '4424.093750' 2024-09-10 18:14:07 (25244): VM state change detected. (old = 'running', new = 'paused') 2024-09-10 18:14:27 (25244): VM state change detected. (old = 'paused', new = 'running') 2024-09-10 18:26:27 (25244): VM state change detected. (old = 'running', new = 'paused') 2024-09-10 18:26:47 (25244): VM state change detected. (old = 'paused', new = 'running') 2024-09-10 18:30:30 (25244): VM state change detected. (old = 'running', new = 'paused') 2024-09-10 18:30:50 (25244): VM state change detected. (old = 'paused', new = 'running') 2024-09-10 18:52:38 (25244): VM state change detected. (old = 'running', new = 'paused') 2024-09-10 18:52:58 (25244): VM state change detected. (old = 'paused', new = 'running') 2024-09-10 19:55:11 (25244): Status Report: Job Duration: '864000.000000' 2024-09-10 19:55:11 (25244): Status Report: Elapsed Time: '12000.000000' 2024-09-10 19:55:11 (25244): Status Report: CPU Time: '8988.812500' 2024-09-10 20:32:20 (25244): VM state change detected. (old = 'running', new = 'paused') 2024-09-10 20:32:40 (25244): VM state change detected. (old = 'paused', new = 'running') 2024-09-10 20:42:06 (25244): VM state change detected. (old = 'running', new = 'paused') 2024-09-10 20:42:26 (25244): VM state change detected. (old = 'paused', new = 'running') 2024-09-10 21:17:37 (25244): VM state change detected. (old = 'running', new = 'paused') 2024-09-10 21:17:57 (25244): VM state change detected. (old = 'paused', new = 'running') 2024-09-10 21:36:19 (25244): Status Report: Job Duration: '864000.000000' 2024-09-10 21:36:19 (25244): Status Report: Elapsed Time: '18000.000000' 2024-09-10 21:36:19 (25244): Status Report: CPU Time: '13554.312500' 2024-09-10 21:53:11 (25244): VM state change detected. (old = 'running', new = 'paused') 2024-09-10 21:53:31 (25244): VM state change detected. (old = 'paused', new = 'running') 2024-09-10 23:16:45 (25244): Status Report: Job Duration: '864000.000000' 2024-09-10 23:16:45 (25244): Status Report: Elapsed Time: '24000.000000' 2024-09-10 23:16:45 (25244): Status Report: CPU Time: '18116.265625' 2024-09-11 00:56:50 (25244): Status Report: Job Duration: '864000.000000' 2024-09-11 00:56:50 (25244): Status Report: Elapsed Time: '30000.000000' 2024-09-11 00:56:50 (25244): Status Report: CPU Time: '22677.968750' 2024-09-11 02:36:54 (25244): Status Report: Job Duration: '864000.000000' 2024-09-11 02:36:54 (25244): Status Report: Elapsed Time: '36000.000000' 2024-09-11 02:36:54 (25244): Status Report: CPU Time: '27236.781250' 2024-09-11 02:47:01 (25244): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 02:47:22 (25244): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 04:17:21 (25244): Status Report: Job Duration: '864000.000000' 2024-09-11 04:17:21 (25244): Status Report: Elapsed Time: '42000.000000' 2024-09-11 04:17:21 (25244): Status Report: CPU Time: '31806.312500' 2024-09-11 06:01:21 (25244): Status Report: Job Duration: '864000.000000' 2024-09-11 06:01:21 (25244): Status Report: Elapsed Time: '48000.726181' 2024-09-11 06:01:21 (25244): Status Report: CPU Time: '36397.562500' 2024-09-11 07:41:25 (25244): Status Report: Job Duration: '864000.000000' 2024-09-11 07:41:25 (25244): Status Report: Elapsed Time: '54000.726181' 2024-09-11 07:41:25 (25244): Status Report: CPU Time: '40959.687500' 2024-09-11 09:21:30 (25244): Status Report: Job Duration: '864000.000000' 2024-09-11 09:21:30 (25244): Status Report: Elapsed Time: '60000.726181' 2024-09-11 09:21:30 (25244): Status Report: CPU Time: '45520.671875' 2024-09-11 11:01:34 (25244): Status Report: Job Duration: '864000.000000' 2024-09-11 11:01:34 (25244): Status Report: Elapsed Time: '66000.726181' 2024-09-11 11:01:34 (25244): Status Report: CPU Time: '50083.250000' 2024-09-11 11:01:50 (25244): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 11:02:11 (25244): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 11:03:42 (25244): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 11:04:02 (25244): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 11:49:56 (25244): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 11:50:16 (25244): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 12:42:47 (25244): Status Report: Job Duration: '864000.000000' 2024-09-11 12:42:47 (25244): Status Report: Elapsed Time: '72000.726181' 2024-09-11 12:42:47 (25244): Status Report: CPU Time: '54651.781250' 2024-09-11 14:06:27 (19636): vboxwrapper version 26207 2024-09-11 14:06:27 (19636): BOINC client version: 8.0.2 2024-09-11 14:06:28 (19636): Detected: VirtualBox VboxManage Interface (Version: 7.0.20) 2024-09-11 14:06:29 (19636): Detected: Heartbeat check (file: 'heartbeat' every 1200.000000 seconds) 2024-09-11 14:06:30 (19636): Guest Log: 01:03:07.191503 timesync vgsvcTimeSyncWorker: Radical host time change: 616 492 483 000 000ns (HostNow=1 726 007 829 115 000 000 ns HostLast=1 725 391 336 632 000 000 ns) 2024-09-11 14:06:30 (19636): Guest Log: 01:03:17.216250 timesync vgsvcTimeSyncWorker: Radical guest time change: 616 509 890 276 000ns (GuestNow=1 726 007 839 143 328 000 ns GuestLast=1 725 391 329 253 052 000 ns fSetTimeLastLoop=true ) 2024-09-11 14:06:30 (19636): Starting VM using VBoxManage interface. (boinc_0d3bb89ff12b6e8c, slot#16) 2024-09-11 14:06:41 (19636): Successfully started VM. (PID = '26456') 2024-09-11 14:06:41 (19636): Reporting VM Process ID to BOINC. 2024-09-11 14:06:41 (19636): Guest Log: BIOS: VirtualBox 7.0.20 2024-09-11 14:06:41 (19636): Guest Log: CPUID EDX: 0x178bfbff 2024-09-11 14:06:41 (19636): Guest Log: BIOS: No PCI IDE controller, not probing IDE 2024-09-11 14:06:41 (19636): Guest Log: BIOS: AHCI 0-P#0: PCHS=16383/16/63 LCHS=1024/255/63 0x0000000002800000 sectors 2024-09-11 14:06:41 (19636): VM state change detected. (old = 'poweredoff', new = 'running') 2024-09-11 14:06:41 (19636): Detected: Web Application Enabled (http://localhost:55448) 2024-09-11 14:06:41 (19636): Status Report: Job Duration: '864000.000000' 2024-09-11 14:06:41 (19636): Status Report: Elapsed Time: '72334.726181' 2024-09-11 14:06:41 (19636): Status Report: CPU Time: '54902.812500' 2024-09-11 14:06:41 (19636): Preference change detected 2024-09-11 14:06:41 (19636): Setting CPU throttle for VM. (70%) 2024-09-11 14:06:41 (19636): Setting checkpoint interval to 600 seconds. (Higher value of (Preference: 60 seconds) or (Vbox_job.xml: 600 seconds)) 2024-09-11 14:06:43 (19636): Guest Log: BIOS: Boot : bseqnr=1, bootseq=0032 2024-09-11 14:06:43 (19636): Guest Log: BIOS: Booting from Hard Disk... 2024-09-11 14:06:46 (19636): Guest Log: BIOS: KBD: unsupported int 16h function 03 2024-09-11 14:06:46 (19636): Guest Log: BIOS: AX=0305 BX=0000 CX=0000 DX=0000 2024-09-11 14:07:07 (19636): Guest Log: vgdrvHeartbeatInit: Setting up heartbeat to trigger every 2000 milliseconds 2024-09-11 14:07:07 (19636): Guest Log: vboxguest: misc device minor 56, IRQ 20, I/O port d020, MMIO at 00000000f0400000 (size 0x400000) 2024-09-11 14:07:13 (19636): Guest Log: VBoxService 5.2.6 r120293 (verbosity: 0) linux.amd64 (Jan 15 2018 14:51:00) release log 2024-09-11 14:07:13 (19636): Guest Log: 00:00:00.000161 main Log opened 2024-09-11T19:07:13.167098000Z 2024-09-11 14:07:13 (19636): Guest Log: 00:00:00.000334 main OS Product: Linux 2024-09-11 14:07:13 (19636): Guest Log: 00:00:00.000422 main OS Release: 4.14.76-13.cernvm.x86_64 2024-09-11 14:07:13 (19636): Guest Log: 00:00:00.000468 main OS Version: #1 SMP Tue Oct 16 18:26:15 CEST 2018 2024-09-11 14:07:13 (19636): Guest Log: 00:00:00.000506 main Executable: /usr/sbin/VBoxService 2024-09-11 14:07:13 (19636): Guest Log: 00:00:00.000507 main Process ID: 3221 2024-09-11 14:07:13 (19636): Guest Log: 00:00:00.000508 main Package type: LINUX_64BITS_GENERIC 2024-09-11 14:07:13 (19636): Guest Log: 00:00:00.007698 main 5.2.6 r120293 started. Verbose level = 0 2024-09-11 14:07:38 (19636): Guest Log: 21:07:38 CEST +02:00 2024-09-11: cranky: [INFO] Detected Theory App 2024-09-11 14:07:39 (19636): Guest Log: 21:07:38 CEST +02:00 2024-09-11: cranky: [INFO] Checking CVMFS. 2024-09-11 14:07:40 (19636): Guest Log: Probing /cvmfs/sft.cern.ch... OK 2024-09-11 14:07:41 (19636): 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-09-11 14:07:41 (19636): Guest Log: 2.5.2.0 4125 0 28624 30437 3 1 1182373 4096000 0 65024 0 0 n/a 5 5 http://s1cern-cvmfs.openhtc.io/cvmfs/sft.cern.ch DIRECT 1 2024-09-11 14:07:42 (19636): Guest Log: Probing /cvmfs/grid.cern.ch... OK 2024-09-11 14:07:43 (19636): 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-09-11 14:07:43 (19636): Guest Log: 2.5.2.0 4082 0 27512 25209 3 2 1182373 4096000 0 65024 0 2 0 7926 9017 http://s1unl-cvmfs.openhtc.io/cvmfs/grid.cern.ch DIRECT 1 2024-09-11 14:07:43 (19636): Guest Log: Probing /cvmfs/cernvm-prod.cern.ch... OK 2024-09-11 14:07:45 (19636): 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-09-11 14:07:45 (19636): Guest Log: 2.5.2.0 4056 0 28456 272 3 1 1182373 4096000 0 65024 0 0 n/a 0 0 http://s1unl-cvmfs.openhtc.io/cvmfs/cernvm-prod.cern.ch DIRECT 1 2024-09-11 14:07:46 (19636): Guest Log: Probing /cvmfs/alice.cern.ch... OK 2024-09-11 14:07:47 (19636): 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-09-11 14:07:47 (19636): Guest Log: 2.5.2.0 4103 0 39644 19679 3 1 1182373 4096000 0 65024 0 0 n/a 5865 7040 http://s1bnl-cvmfs.openhtc.io/cvmfs/alice.cern.ch DIRECT 1 2024-09-11 14:07:47 (19636): Guest Log: 21:07:47 CEST +02:00 2024-09-11: cranky: [INFO] Checking runc. 2024-09-11 14:07:47 (19636): Guest Log: 21:07:47 CEST +02:00 2024-09-11: cranky: [INFO] Creating the filesystem. 2024-09-11 14:07:47 (19636): Guest Log: 21:07:47 CEST +02:00 2024-09-11: cranky: [INFO] Using /cvmfs/cernvm-prod.cern.ch/cvm4 2024-09-11 14:07:47 (19636): Guest Log: 21:07:47 CEST +02:00 2024-09-11: cranky: [INFO] Updating config.json. 2024-09-11 14:07:47 (19636): Guest Log: 21:07:47 CEST +02:00 2024-09-11: cranky: [INFO] Running Container 'runc'. 2024-09-11 14:07:48 (19636): Guest Log: job: htmld=/shared/html/job 2024-09-11 14:07:48 (19636): Guest Log: job: unpack exitcode=0 2024-09-11 14:07:48 (19636): Guest Log: INFO: activated the work-around for ld: 2024-09-11 14:07:48 (19636): Guest Log: lrwxrwxrwx 1 0 0 15 Sep 11 19:07 /tmp/tmp.bM5vEULUTI/ld -> /usr/bin/ld.bfd 2024-09-11 14:07:50 (19636): Guest Log: 21:07:49 CEST +02:00 2024-09-11: cranky: [INFO] ===> [runRivet] Wed Sep 11 19:07:48 UTC 2024 [boinc pp jets 13000 180 - pythia8 8.244 tune-A2m 100000 406] 2024-09-11 14:10:05 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 14:10:10 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 14:11:01 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 14:11:21 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 14:13:22 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 14:13:43 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 14:15:34 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 14:15:54 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 14:17:46 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 14:18:06 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 14:27:12 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 14:27:32 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 14:35:39 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 14:35:59 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 14:45:36 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 14:45:56 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 14:54:22 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 14:54:42 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 14:58:26 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 14:58:46 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 15:01:08 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 15:01:28 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 15:10:26 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 15:10:46 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 15:20:54 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 15:21:14 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 15:23:16 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 15:23:36 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 15:31:02 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 15:31:22 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 15:50:37 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 15:50:58 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 15:52:23 (19636): Status Report: Job Duration: '864000.000000' 2024-09-11 15:52:23 (19636): Status Report: Elapsed Time: '78334.726181' 2024-09-11 15:52:23 (19636): Status Report: CPU Time: '59399.031250' 2024-09-11 15:53:41 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 15:54:01 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 15:56:42 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 15:57:02 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 16:05:08 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 16:05:29 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 16:08:01 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 16:08:21 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 16:21:32 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 16:21:53 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 16:23:34 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 16:23:54 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 16:26:46 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 16:27:06 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 16:30:29 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 16:30:49 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 16:32:51 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 16:33:12 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 16:34:12 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 16:34:32 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 16:47:12 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 16:47:32 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 16:47:52 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 16:48:12 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 16:57:10 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 16:57:30 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 17:18:27 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 17:18:47 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 17:22:40 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 17:23:00 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 17:29:04 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 17:29:24 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 17:38:07 (19636): Status Report: Job Duration: '864000.000000' 2024-09-11 17:38:07 (19636): Status Report: Elapsed Time: '84334.726181' 2024-09-11 17:38:07 (19636): Status Report: CPU Time: '63971.718750' 2024-09-11 18:54:42 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 18:55:02 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 18:59:25 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 18:59:45 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 19:02:27 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 19:02:47 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 19:03:58 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 19:04:18 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 19:19:36 (19636): Status Report: Job Duration: '864000.000000' 2024-09-11 19:19:36 (19636): Status Report: Elapsed Time: '90334.726181' 2024-09-11 19:19:36 (19636): Status Report: CPU Time: '68534.250000' 2024-09-11 19:20:51 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 19:21:11 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 19:47:12 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 19:47:32 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 19:49:54 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 19:50:14 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 20:03:24 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 20:03:44 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 20:13:31 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 20:13:51 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 20:14:21 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 20:14:41 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 20:18:13 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 20:18:34 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 20:19:35 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 20:19:56 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 20:21:58 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 20:22:18 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 20:27:42 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 20:28:02 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 20:41:01 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 20:41:21 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 20:42:03 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 20:42:23 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 20:55:02 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 20:55:23 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 20:59:15 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 20:59:35 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 21:04:37 (19636): Status Report: Job Duration: '864000.000000' 2024-09-11 21:04:37 (19636): Status Report: Elapsed Time: '96334.726181' 2024-09-11 21:04:37 (19636): Status Report: CPU Time: '73113.265625' 2024-09-11 21:23:15 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 21:23:35 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 21:29:59 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 21:30:19 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 21:32:01 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 21:32:21 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 21:38:05 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 21:38:25 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 21:40:28 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 21:40:48 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 21:44:11 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 21:44:31 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 21:48:14 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 21:48:34 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 21:49:15 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 21:49:35 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 22:14:14 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 22:14:34 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 22:25:25 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 22:25:45 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 22:48:12 (19636): Status Report: Job Duration: '864000.000000' 2024-09-11 22:48:12 (19636): Status Report: Elapsed Time: '102334.726181' 2024-09-11 22:48:12 (19636): Status Report: CPU Time: '77691.109375' 2024-09-11 22:57:19 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 22:57:40 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 23:01:14 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 23:01:35 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 23:12:34 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 23:12:54 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 23:47:41 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 23:48:02 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 23:51:34 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 23:51:54 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-11 23:57:20 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-11 23:57:40 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 00:00:12 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 00:00:32 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 00:22:20 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 00:22:40 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 00:30:18 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 00:30:38 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 00:31:29 (19636): Status Report: Job Duration: '864000.000000' 2024-09-12 00:31:29 (19636): Status Report: Elapsed Time: '108334.726181' 2024-09-12 00:31:29 (19636): Status Report: CPU Time: '82263.578125' 2024-09-12 00:49:37 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 00:49:58 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 02:11:57 (19636): Status Report: Job Duration: '864000.000000' 2024-09-12 02:11:57 (19636): Status Report: Elapsed Time: '114334.726181' 2024-09-12 02:11:57 (19636): Status Report: CPU Time: '86829.546875' 2024-09-12 02:21:56 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 02:22:17 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 02:48:08 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 02:48:29 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 03:52:46 (19636): Status Report: Job Duration: '864000.000000' 2024-09-12 03:52:46 (19636): Status Report: Elapsed Time: '120334.726181' 2024-09-12 03:52:46 (19636): Status Report: CPU Time: '91396.390625' 2024-09-12 04:06:39 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 04:06:59 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 04:08:30 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 04:08:50 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 04:35:05 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 04:35:25 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 04:50:38 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 04:50:58 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 05:01:20 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 05:01:41 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 05:09:59 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 05:10:20 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 05:22:31 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 05:22:51 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 05:33:32 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 05:33:52 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 05:37:27 (19636): Status Report: Job Duration: '864000.000000' 2024-09-12 05:37:27 (19636): Status Report: Elapsed Time: '126334.939989' 2024-09-12 05:37:27 (19636): Status Report: CPU Time: '95977.843750' 2024-09-12 05:39:58 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 05:40:18 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 05:40:58 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 05:41:18 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 05:55:33 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 05:55:53 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 06:24:52 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 06:25:12 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 06:44:42 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 06:45:02 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 07:19:18 (19636): Status Report: Job Duration: '864000.000000' 2024-09-12 07:19:18 (19636): Status Report: Elapsed Time: '132334.939989' 2024-09-12 07:19:18 (19636): Status Report: CPU Time: '100552.234375' 2024-09-12 07:39:57 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 07:40:17 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 07:40:58 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 07:41:18 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 07:43:21 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 07:43:41 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 07:50:18 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 07:50:38 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 07:51:19 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 07:51:39 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 08:23:08 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 08:23:28 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 08:29:13 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 08:29:33 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 08:38:53 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 08:39:13 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 08:55:30 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 08:55:50 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 09:02:32 (19636): Status Report: Job Duration: '864000.000000' 2024-09-12 09:02:32 (19636): Status Report: Elapsed Time: '138334.939989' 2024-09-12 09:02:32 (19636): Status Report: CPU Time: '105124.843750' 2024-09-12 09:03:18 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 09:03:38 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 09:27:21 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 09:27:41 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 09:36:41 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 09:37:01 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 09:44:39 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 09:44:59 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 10:09:13 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 10:09:33 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 10:14:18 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 10:14:38 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 10:35:18 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 10:35:38 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 10:37:50 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 10:38:11 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 10:45:25 (19636): Status Report: Job Duration: '864000.000000' 2024-09-12 10:45:25 (19636): Status Report: Elapsed Time: '144334.939989' 2024-09-12 10:45:25 (19636): Status Report: CPU Time: '109694.171875' 2024-09-12 10:56:50 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 10:57:10 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 11:06:11 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 11:06:31 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 11:10:55 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 11:11:15 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 11:12:16 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 11:12:36 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 11:21:48 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 11:22:08 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 11:26:33 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 11:26:53 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 11:40:07 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 11:40:27 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 11:43:42 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 11:44:02 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 11:47:05 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 11:47:25 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 11:59:18 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 11:59:38 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 12:02:51 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 12:03:11 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 12:07:57 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 12:08:18 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 12:11:00 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 12:11:21 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 12:13:13 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 12:13:33 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 12:18:59 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 12:19:19 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 12:20:00 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 12:20:20 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 12:29:01 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 12:29:21 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 12:29:41 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 12:30:01 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 12:31:50 (19636): Status Report: Job Duration: '864000.000000' 2024-09-12 12:31:50 (19636): Status Report: Elapsed Time: '150334.939989' 2024-09-12 12:31:50 (19636): Status Report: CPU Time: '114275.062500' 2024-09-12 12:47:42 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 12:48:02 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 12:48:32 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 12:48:52 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 12:49:33 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 12:49:53 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 13:06:10 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 13:06:30 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 13:41:49 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 13:42:09 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 13:48:05 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 13:48:25 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 13:56:54 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 13:57:14 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 14:10:17 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 14:10:37 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 14:14:43 (19636): Status Report: Job Duration: '864000.000000' 2024-09-12 14:14:43 (19636): Status Report: Elapsed Time: '156334.939989' 2024-09-12 14:14:43 (19636): Status Report: CPU Time: '118851.578125' 2024-09-12 14:17:45 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 14:18:05 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 14:22:30 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 14:22:50 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 14:23:51 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 14:24:11 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 14:50:50 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 14:51:10 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 15:56:11 (19636): Status Report: Job Duration: '864000.000000' 2024-09-12 15:56:11 (19636): Status Report: Elapsed Time: '162334.939989' 2024-09-12 15:56:11 (19636): Status Report: CPU Time: '123430.765625' 2024-09-12 16:16:21 (19636): VM state change detected. (old = 'running', new = 'paused') 2024-09-12 16:16:41 (19636): VM state change detected. (old = 'paused', new = 'running') 2024-09-12 16:44:06 (19636): Guest Log: job: run exitcode=0 2024-09-12 16:44:06 (19636): Guest Log: job: diskusage=16372 2024-09-12 16:44:06 (19636): Guest Log: job: logsize=104 k 2024-09-12 16:44:06 (19636): Guest Log: job: times= 2024-09-12 16:44:06 (19636): Guest Log: 0m0.007s 0m0.019s 2024-09-12 16:44:06 (19636): Guest Log: 1524m40.929s 8m51.549s 2024-09-12 16:44:06 (19636): Guest Log: job: cpuusage=92013 2024-09-12 16:44:07 (19636): Guest Log: 23:40:52 CEST +02:00 2024-09-12: cranky: [INFO] Container 'runc' finished with status code 0. 2024-09-12 16:44:07 (19636): Guest Log: 23:40:52 CEST +02:00 2024-09-12: cranky: [INFO] Preparing output. 2024-09-12 16:44:07 (19636): Guest Log: [INFO] Job Finished 2024-09-12 16:44:07 (19636): Guest Log: [INFO] Shutting Down. 2024-09-12 16:44:07 (19636): VM Completion File Detected. 2024-09-12 16:44:07 (19636): VM Completion Message: Job Finished . 2024-09-12 16:44:07 (19636): Powering off VM. 2024-09-12 16:44:07 (19636): Successfully stopped VM. 2024-09-12 16:44:07 (19636): Deregistering VM. (boinc_0d3bb89ff12b6e8c, slot#16) 2024-09-12 16:44:07 (19636): Removing network bandwidth throttle group from VM. 2024-09-12 16:44:07 (19636): Removing VM from VirtualBox. 2024-09-12 16:44:13 (19636): called boinc_finish(0) </stderr_txt> ]]>
©2025 CERN