Name ze0LDmZ9BS8n9Rq4apOajLDm4fhM0noT9bVof3QYDmH5TMDmR7NR2n_0
Workunit 235931478
Created 12 Oct 2025, 14:23:12 UTC
Sent 12 Oct 2025, 15:37:56 UTC
Report deadline 20 Oct 2025, 15:37:56 UTC
Received 13 Oct 2025, 10:52:45 UTC
Server state Over
Outcome Success
Client state Done
Exit status 0 (0x00000000)
Computer ID 10874991
Run time 16 hours 12 min 36 sec
CPU time 11 hours 25 min 47 sec
Validate state Valid
Credit 1,664.19
Device peak FLOPS 32.86 GFLOPS
Application version ATLAS Simulation v3.01 (native_mt)
x86_64-pc-linux-gnu
Peak working set size 2.68 GB
Peak swap size 31.65 GB
Peak disk usage 829.28 MB

Stderr output

<core_client_version>8.1.0</core_client_version>
<![CDATA[
<stderr_txt>
12:22:41 (3288949): wrapper (7.7.26015): starting
12:22:41 (3288949): wrapper: running run_atlas (--nthreads 11)
[2025-10-12 12:22:41] Arguments: --nthreads 11
[2025-10-12 12:22:41] Threads: 11
[2025-10-12 12:22:41] Checking for CVMFS
[2025-10-12 12:22:41] Probing /cvmfs/atlas.cern.ch... OK
[2025-10-12 12:22:41] Probing /cvmfs/atlas-condb.cern.ch... OK
[2025-10-12 12:22:41] Running cvmfs_config stat atlas.cern.ch
[2025-10-12 12:22:42] 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
[2025-10-12 12:22:42] 2.13.2.0 3951459 77633 562892 151625 2 745 28841806 32935937 54140 16776704 0 571858524 99.687 465881660 15012 http://cvmfs-s1fnal.opensciencegrid.org:8000/cvmfs/atlas.cern.ch http://192.41.231.239:6081 1
[2025-10-12 12:22:42] CVMFS is ok
[2025-10-12 12:22:42] Efficiency of ATLAS tasks can be improved by the following measure(s):
[2025-10-12 12:22:42] The CVMFS client on this computer should be configured to use Cloudflare's openhtc.io.
[2025-10-12 12:22:42] Further information can be found at the LHC@home message board.
[2025-10-12 12:22:42] Using apptainer image /cvmfs/atlas.cern.ch/repo/containers/fs/singularity/x86_64-centos7
[2025-10-12 12:22:42] Checking for apptainer binary...
[2025-10-12 12:22:42] Using apptainer found in PATH at /usr/bin/apptainer
[2025-10-12 12:22:42] Running /usr/bin/apptainer --version
[2025-10-12 12:22:42] apptainer version 1.4.3-1.el9
[2025-10-12 12:22:42] Checking apptainer works with /usr/bin/apptainer exec -B /cvmfs /cvmfs/atlas.cern.ch/repo/containers/fs/singularity/x86_64-centos7 hostname
[2025-10-12 12:22:42] c7-6-31.aglt2.org
[2025-10-12 12:22:42] apptainer works
[2025-10-12 12:22:42] Set ATHENA_PROC_NUMBER=11
[2025-10-12 12:22:42] Set ATHENA_CORE_NUMBER=11
[2025-10-12 12:22:42] Starting ATLAS job with PandaID=6840181691
[2025-10-12 12:22:42] Running command: /usr/bin/apptainer exec -B /cvmfs,/tmp/boinchome/slots/0 /cvmfs/atlas.cern.ch/repo/containers/fs/singularity/x86_64-centos7 sh start_atlas.sh
21:20:11 (3288949): BOINC client no longer exists - exiting
21:20:11 (3288949): timer handler: client dead, exiting
21:31:58 (3635615): wrapper (7.7.26015): starting
21:31:58 (3635615): wrapper: running run_atlas (--nthreads 8)
[2025-10-12 21:31:58] Arguments: --nthreads 8
[2025-10-12 21:31:58] Threads: 8
[2025-10-12 21:31:58] This job has been restarted, cleaning up previous attempt
[2025-10-12 21:31:58] Checking for CVMFS
[2025-10-12 21:31:59] Probing /cvmfs/atlas.cern.ch... OK
[2025-10-12 21:31:59] Probing /cvmfs/atlas-condb.cern.ch... OK
[2025-10-12 21:31:59] Running cvmfs_config stat atlas.cern.ch
[2025-10-12 21:31:59] 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
[2025-10-12 21:31:59] 2.13.2.0 3951459 78182 559568 151643 2 680 20957693 32935936 46738 16776704 0 577387608 99.690 466611237 15013 http://cvmfs-s1fnal.opensciencegrid.org:8000/cvmfs/atlas.cern.ch http://192.41.231.239:6081 1
[2025-10-12 21:31:59] CVMFS is ok
[2025-10-12 21:31:59] Efficiency of ATLAS tasks can be improved by the following measure(s):
[2025-10-12 21:31:59] The CVMFS client on this computer should be configured to use Cloudflare's openhtc.io.
[2025-10-12 21:31:59] Further information can be found at the LHC@home message board.
[2025-10-12 21:31:59] Using apptainer image /cvmfs/atlas.cern.ch/repo/containers/fs/singularity/x86_64-centos7
[2025-10-12 21:31:59] Checking for apptainer binary...
[2025-10-12 21:31:59] Using apptainer found in PATH at /usr/bin/apptainer
[2025-10-12 21:31:59] Running /usr/bin/apptainer --version
[2025-10-12 21:31:59] apptainer version 1.4.3-1.el9
[2025-10-12 21:31:59] Checking apptainer works with /usr/bin/apptainer exec -B /cvmfs /cvmfs/atlas.cern.ch/repo/containers/fs/singularity/x86_64-centos7 hostname
[2025-10-12 21:32:00] c7-6-31.aglt2.org
[2025-10-12 21:32:00] apptainer works
[2025-10-12 21:32:00] Set ATHENA_PROC_NUMBER=8
[2025-10-12 21:32:00] Set ATHENA_CORE_NUMBER=8
[2025-10-12 21:32:00] Starting ATLAS job with PandaID=6840181691
[2025-10-12 21:32:00] Running command: /usr/bin/apptainer exec -B /cvmfs,/tmp/boinchome/slots/0 /cvmfs/atlas.cern.ch/repo/containers/fs/singularity/x86_64-centos7 sh start_atlas.sh
22:45:22 (399008): wrapper (7.7.26015): starting
22:45:22 (399008): wrapper: running run_atlas (--nthreads 9)
[2025-10-12 22:45:22] Arguments: --nthreads 9
[2025-10-12 22:45:22] Threads: 9
[2025-10-12 22:45:22] This job has been restarted, cleaning up previous attempt
[2025-10-12 22:45:22] Checking for CVMFS
[2025-10-12 22:45:22] Probing /cvmfs/atlas.cern.ch... OK
[2025-10-12 22:45:22] Probing /cvmfs/atlas-condb.cern.ch... OK
[2025-10-12 22:45:22] Running cvmfs_config stat atlas.cern.ch
[2025-10-12 22:45:23] 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
[2025-10-12 22:45:23] 2.13.2.0 3951459 78255 547184 151645 1 352 21700677 32935936 48871 16776704 0 578885007 99.691 466675609 15013 http://cvmfs-s1fnal.opensciencegrid.org:8000/cvmfs/atlas.cern.ch http://192.41.231.239:6081 1
[2025-10-12 22:45:23] CVMFS is ok
[2025-10-12 22:45:23] Efficiency of ATLAS tasks can be improved by the following measure(s):
[2025-10-12 22:45:23] The CVMFS client on this computer should be configured to use Cloudflare's openhtc.io.
[2025-10-12 22:45:23] Further information can be found at the LHC@home message board.
[2025-10-12 22:45:23] Using apptainer image /cvmfs/atlas.cern.ch/repo/containers/fs/singularity/x86_64-centos7
[2025-10-12 22:45:23] Checking for apptainer binary...
[2025-10-12 22:45:23] Using apptainer found in PATH at /usr/bin/apptainer
[2025-10-12 22:45:23] Running /usr/bin/apptainer --version
[2025-10-12 22:45:23] apptainer version 1.4.3-1.el9
[2025-10-12 22:45:23] Checking apptainer works with /usr/bin/apptainer exec -B /cvmfs /cvmfs/atlas.cern.ch/repo/containers/fs/singularity/x86_64-centos7 hostname
[2025-10-12 22:45:23] c7-6-31.aglt2.org
[2025-10-12 22:45:23] apptainer works
[2025-10-12 22:45:23] Set ATHENA_PROC_NUMBER=9
[2025-10-12 22:45:23] Set ATHENA_CORE_NUMBER=9
[2025-10-12 22:45:23] Starting ATLAS job with PandaID=6840181691
[2025-10-12 22:45:23] Running command: /usr/bin/apptainer exec -B /cvmfs,/tmp/boinchome/slots/0 /cvmfs/atlas.cern.ch/repo/containers/fs/singularity/x86_64-centos7 sh start_atlas.sh
[2025-10-13 06:48:03]  *** The last 200 lines of the pilot log: ***
[2025-10-13 06:48:03] 2025-10-13 10:47:08,504 | WARNING  | format EVNTtoHITS has no such key: dbTime
[2025-10-13 06:48:03] 2025-10-13 10:47:08,533 | INFO     | fitting pss+swap vs Time
[2025-10-13 06:48:03] 2025-10-13 10:47:08,533 | INFO     | sum of square deviations: 32813809005.873295
[2025-10-13 06:48:03] 2025-10-13 10:47:08,546 | INFO     | sum of deviations: -17022302226.057102
[2025-10-13 06:48:03] 2025-10-13 10:47:08,546 | INFO     | mean x: 1760337973.1310782
[2025-10-13 06:48:03] 2025-10-13 10:47:08,546 | INFO     | mean y: 2153562.758985201
[2025-10-13 06:48:03] 2025-10-13 10:47:08,546 | INFO     | -- intersect: 915336332.6495093
[2025-10-13 06:48:03] 2025-10-13 10:47:08,546 | INFO     | intersect: 915336332.6495093
[2025-10-13 06:48:03] 2025-10-13 10:47:08,555 | INFO     | chi2: 3.798309199725304
[2025-10-13 06:48:03] 2025-10-13 10:47:08,555 | INFO     | sum of square deviations: 31784171400.786404
[2025-10-13 06:48:03] 2025-10-13 10:47:08,567 | INFO     | sum of deviations: 61022472401.256355
[2025-10-13 06:48:03] 2025-10-13 10:47:08,567 | INFO     | mean x: 1760337820.6324787
[2025-10-13 06:48:03] 2025-10-13 10:47:08,567 | INFO     | mean y: 2165076.141025641
[2025-10-13 06:48:03] 2025-10-13 10:47:08,567 | INFO     | -- intersect: -3377509816.808218
[2025-10-13 06:48:03] 2025-10-13 10:47:08,567 | INFO     | intersect: -3377509816.808218
[2025-10-13 06:48:03] 2025-10-13 10:47:08,568 | INFO     | chi2: 1.7661947590933411
[2025-10-13 06:48:03] 2025-10-13 10:47:08,568 | INFO     | current chi2=1.7661947590933411 (change=53.500500716974976 %)
[2025-10-13 06:48:03] 2025-10-13 10:47:08,568 | INFO     | sum of square deviations: 30776301645.69757
[2025-10-13 06:48:03] 2025-10-13 10:47:08,572 | INFO     | sum of deviations: 63858135746.93515
[2025-10-13 06:48:03] 2025-10-13 10:47:08,572 | INFO     | mean x: 1760337668.1339092
[2025-10-13 06:48:03] 2025-10-13 10:47:08,572 | INFO     | mean y: 2165505.7429805617
[2025-10-13 06:48:03] 2025-10-13 10:47:08,572 | INFO     | -- intersect: -3650381283.869516
[2025-10-13 06:48:03] 2025-10-13 10:47:08,572 | INFO     | intersect: -3650381283.869516
[2025-10-13 06:48:03] 2025-10-13 10:47:08,581 | INFO     | chi2: 1.7616517837609271
[2025-10-13 06:48:03] 2025-10-13 10:47:08,581 | INFO     | current chi2=1.7616517837609271 (change=0.25721825461344267 %)
[2025-10-13 06:48:03] 2025-10-13 10:47:08,581 | INFO     | right removable region: 462
[2025-10-13 06:48:03] 2025-10-13 10:47:08,586 | INFO     | sum of square deviations: 31784133580.786404
[2025-10-13 06:48:03] 2025-10-13 10:47:08,594 | INFO     | sum of deviations: -87665191250.97437
[2025-10-13 06:48:03] 2025-10-13 10:47:08,594 | INFO     | mean x: 1760338125.6324787
[2025-10-13 06:48:03] 2025-10-13 10:47:08,594 | INFO     | mean y: 2163987.314102564
[2025-10-13 06:48:03] 2025-10-13 10:47:08,594 | INFO     | -- intersect: 4857428582.07531
[2025-10-13 06:48:03] 2025-10-13 10:47:08,594 | INFO     | intersect: 4857428582.07531
[2025-10-13 06:48:03] 2025-10-13 10:47:08,594 | INFO     | chi2: 2.293869477359948
[2025-10-13 06:48:03] 2025-10-13 10:47:08,594 | INFO     | current chi2=2.293869477359948 (change=39.60814255127408 %)
[2025-10-13 06:48:03] 2025-10-13 10:47:08,595 | INFO     | sum of square deviations: 30776226005.69757
[2025-10-13 06:48:03] 2025-10-13 10:47:08,607 | INFO     | sum of deviations: -90039142358.31966
[2025-10-13 06:48:03] 2025-10-13 10:47:08,607 | INFO     | mean x: 1760338278.1339092
[2025-10-13 06:48:03] 2025-10-13 10:47:08,607 | INFO     | mean y: 2164346.1987041035
[2025-10-13 06:48:03] 2025-10-13 10:47:08,607 | INFO     | -- intersect: 5152222342.080185
[2025-10-13 06:48:03] 2025-10-13 10:47:08,607 | INFO     | intersect: 5152222342.080185
[2025-10-13 06:48:03] 2025-10-13 10:47:08,615 | INFO     | chi2: 2.2906578021043664
[2025-10-13 06:48:03] 2025-10-13 10:47:08,615 | INFO     | current chi2=2.2906578021043664 (change=0.1400112468159215 %)
[2025-10-13 06:48:03] 2025-10-13 10:47:08,615 | INFO     | left removable region: 20
[2025-10-13 06:48:03] 2025-10-13 10:47:08,615 | INFO     | sum of square deviations: 26775553845.80323
[2025-10-13 06:48:03] 2025-10-13 10:47:08,627 | INFO     | sum of deviations: -7952418447.549788
[2025-10-13 06:48:03] 2025-10-13 10:47:08,627 | INFO     | mean x: 1760338247.6402714
[2025-10-13 06:48:03] 2025-10-13 10:47:08,627 | INFO     | mean y: 2176276.5814479636
[2025-10-13 06:48:03] 2025-10-13 10:47:08,627 | INFO     | -- intersect: 525001926.9892785
[2025-10-13 06:48:03] 2025-10-13 10:47:08,627 | INFO     | intersect: 525001926.9892785
[2025-10-13 06:48:03] 2025-10-13 10:47:08,627 | INFO     | chi2: 0.22394603127332605
[2025-10-13 06:48:03] 2025-10-13 10:47:08,628 | INFO     | -- intersect: 525001926.9892785
[2025-10-13 06:48:03] 2025-10-13 10:47:08,628 | INFO     | current memory leak: -0.30 B/s (using 442 data points, chi2=0.22)
[2025-10-13 06:48:03] 2025-10-13 10:47:08,628 | INFO     | could have reported an average CPU frequency of 3372 MHz (19 samples)
[2025-10-13 06:48:03] 2025-10-13 10:47:08,628 | INFO     | ..............................
[2025-10-13 06:48:03] 2025-10-13 10:47:08,628 | INFO     | . Timing measurements:
[2025-10-13 06:48:03] 2025-10-13 10:47:08,629 | INFO     | . get job = 0 s
[2025-10-13 06:48:03] 2025-10-13 10:47:08,629 | INFO     | . initial setup = 1 s
[2025-10-13 06:48:03] 2025-10-13 10:47:08,629 | INFO     | . payload setup = 9 s
[2025-10-13 06:48:03] 2025-10-13 10:47:08,629 | INFO     | . stage-in = 0 s
[2025-10-13 06:48:03] 2025-10-13 10:47:08,629 | INFO     | . payload execution = 28839 s
[2025-10-13 06:48:03] 2025-10-13 10:47:08,629 | INFO     | . stage-out = 3 s
[2025-10-13 06:48:03] 2025-10-13 10:47:08,629 | INFO     | . log creation = 0 s
[2025-10-13 06:48:03] 2025-10-13 10:47:08,629 | INFO     | ..............................
[2025-10-13 06:48:03] 2025-10-13 10:47:08,827 | INFO     | 
[2025-10-13 06:48:03] 2025-10-13 10:47:08,828 | INFO     | job summary report
[2025-10-13 06:48:03] 2025-10-13 10:47:08,828 | INFO     | --------------------------------------------------
[2025-10-13 06:48:03] 2025-10-13 10:47:08,828 | INFO     | PanDA job id: 6840181691
[2025-10-13 06:48:03] 2025-10-13 10:47:08,828 | INFO     | task id: 46676269
[2025-10-13 06:48:03] 2025-10-13 10:47:08,828 | INFO     | errors: (none)
[2025-10-13 06:48:03] 2025-10-13 10:47:08,828 | INFO     | status: LOG_TRANSFER = DONE 
[2025-10-13 06:48:03] 2025-10-13 10:47:08,828 | INFO     | pilot state: finished 
[2025-10-13 06:48:03] 2025-10-13 10:47:08,828 | INFO     | transexitcode: 0
[2025-10-13 06:48:03] 2025-10-13 10:47:08,828 | INFO     | exeerrorcode: 0
[2025-10-13 06:48:03] 2025-10-13 10:47:08,828 | INFO     | exeerrordiag: 
[2025-10-13 06:48:03] 2025-10-13 10:47:08,828 | INFO     | exitcode: 0
[2025-10-13 06:48:03] 2025-10-13 10:47:08,828 | INFO     | exitmsg: OK
[2025-10-13 06:48:03] 2025-10-13 10:47:08,829 | INFO     | cpuconsumptiontime: 32656 s
[2025-10-13 06:48:03] 2025-10-13 10:47:08,829 | INFO     | nevents: 400
[2025-10-13 06:48:03] 2025-10-13 10:47:08,829 | INFO     | neventsw: 0
[2025-10-13 06:48:03] 2025-10-13 10:47:08,829 | INFO     | pid: 455085
[2025-10-13 06:48:03] 2025-10-13 10:47:08,829 | INFO     | pgrp: 455085
[2025-10-13 06:48:03] 2025-10-13 10:47:08,829 | INFO     | corecount: 9
[2025-10-13 06:48:03] 2025-10-13 10:47:08,829 | INFO     | event service: False
[2025-10-13 06:48:03] 2025-10-13 10:47:08,829 | INFO     | sizes: {0: 2348630, 1: 2348885, 8: 2349147, 12: 2349175, 28854: 2385673, 28858: 2394671, 28859: 2394855, 28873: 2395049}
[2025-10-13 06:48:03] 2025-10-13 10:47:08,829 | INFO     | --------------------------------------------------
[2025-10-13 06:48:03] 2025-10-13 10:47:08,829 | INFO     | 
[2025-10-13 06:48:03] 2025-10-13 10:47:08,829 | INFO     | executing command: ls -lF /tmp/boinchome/slots/0
[2025-10-13 06:48:03] 2025-10-13 10:47:09,026 | INFO     | queue jobs had 0 job(s) [purged]
[2025-10-13 06:48:03] 2025-10-13 10:47:09,026 | INFO     | queue payloads had 0 job(s) [purged]
[2025-10-13 06:48:03] 2025-10-13 10:47:09,026 | INFO     | queue data_in had 0 job(s) [purged]
[2025-10-13 06:48:03] 2025-10-13 10:47:09,026 | INFO     | queue data_out had 0 job(s) [purged]
[2025-10-13 06:48:03] 2025-10-13 10:47:09,026 | INFO     | queue current_data_in had 0 job(s) [purged]
[2025-10-13 06:48:03] 2025-10-13 10:47:09,026 | INFO     | queue validated_jobs had 0 job(s) [purged]
[2025-10-13 06:48:03] 2025-10-13 10:47:09,027 | INFO     | queue validated_payloads had 0 job(s) [purged]
[2025-10-13 06:48:03] 2025-10-13 10:47:09,027 | INFO     | queue monitored_payloads had 0 job(s) [purged]
[2025-10-13 06:48:03] 2025-10-13 10:47:09,027 | INFO     | queue finished_jobs had 0 job(s) [purged]
[2025-10-13 06:48:03] 2025-10-13 10:47:09,027 | INFO     | queue finished_payloads had 0 job(s) [purged]
[2025-10-13 06:48:03] 2025-10-13 10:47:09,027 | INFO     | queue finished_data_in had 1 job(s) [purged]
[2025-10-13 06:48:03] 2025-10-13 10:47:09,027 | INFO     | queue finished_data_out had 0 job(s) [purged]
[2025-10-13 06:48:03] 2025-10-13 10:47:09,027 | INFO     | queue failed_jobs had 0 job(s) [purged]
[2025-10-13 06:48:03] 2025-10-13 10:47:09,027 | INFO     | queue failed_payloads had 0 job(s) [purged]
[2025-10-13 06:48:03] 2025-10-13 10:47:09,027 | INFO     | queue failed_data_in had 0 job(s) [purged]
[2025-10-13 06:48:03] 2025-10-13 10:47:09,027 | INFO     | queue failed_data_out had 0 job(s) [purged]
[2025-10-13 06:48:03] 2025-10-13 10:47:09,027 | INFO     | queue completed_jobs had 0 job(s) [purged]
[2025-10-13 06:48:03] 2025-10-13 10:47:09,027 | INFO     | queue completed_jobids has 1 job(s)
[2025-10-13 06:48:03] 2025-10-13 10:47:09,027 | INFO     | queue realtimelog_payloads had 0 job(s) [purged]
[2025-10-13 06:48:03] 2025-10-13 10:47:09,027 | INFO     | queue messages had 0 job(s) [purged]
[2025-10-13 06:48:03] 2025-10-13 10:47:09,027 | INFO     | job 6840181691 has completed (purged errors)
[2025-10-13 06:48:03] 2025-10-13 10:47:09,027 | INFO     | overall cleanup function is called
[2025-10-13 06:48:03] 2025-10-13 10:47:10,079 | INFO     | --- collectZombieJob: --- 10, [455085]
[2025-10-13 06:48:03] 2025-10-13 10:47:10,080 | INFO     | zombie collector waiting for pid 455085
[2025-10-13 06:48:03] 2025-10-13 10:47:10,080 | INFO     | harmless exception when collecting zombies: [Errno 10] No child processes
[2025-10-13 06:48:03] 2025-10-13 10:47:10,080 | INFO     | collected zombie processes
[2025-10-13 06:48:03] 2025-10-13 10:47:10,080 | INFO     | will attempt to kill all subprocesses of pid=455085
[2025-10-13 06:48:03] 2025-10-13 10:47:11,670 | INFO     | process IDs to be killed: [455085] (in reverse order)
[2025-10-13 06:48:03] 2025-10-13 10:47:11,858 | WARNING  | found no corresponding commands to process id(s)
[2025-10-13 06:48:03] 2025-10-13 10:47:11,863 | INFO     | Do not look for orphan processes in BOINC jobs
[2025-10-13 06:48:03] 2025-10-13 10:47:11,958 | INFO     | did not find any defunct processes belonging to 455085
[2025-10-13 06:48:03] 2025-10-13 10:47:12,092 | INFO     | did not find any defunct processes belonging to 455085
[2025-10-13 06:48:03] 2025-10-13 10:47:12,093 | INFO     | ready for new job
[2025-10-13 06:48:03] 2025-10-13 10:47:12,093 | INFO     | pilot has finished with previous job - re-establishing logging
[2025-10-13 06:48:03] 2025-10-13 10:47:12,095 | INFO     | ***************************************
[2025-10-13 06:48:03] 2025-10-13 10:47:12,095 | INFO     | ***  PanDA Pilot version 3.11.0.29  ***
[2025-10-13 06:48:03] 2025-10-13 10:47:12,095 | INFO     | ***************************************
[2025-10-13 06:48:03] 2025-10-13 10:47:12,095 | INFO     | 
[2025-10-13 06:48:03] 2025-10-13 10:47:12,120 | INFO     | architecture information:
[2025-10-13 06:48:03] 2025-10-13 10:47:12,121 | INFO     | executing command: cat /etc/os-release
[2025-10-13 06:48:03] 2025-10-13 10:47:12,139 | INFO     | cat /etc/os-release:
[2025-10-13 06:48:03] NAME="CentOS Linux"
[2025-10-13 06:48:03] VERSION="7 (Core)"
[2025-10-13 06:48:03] ID="centos"
[2025-10-13 06:48:03] ID_LIKE="rhel fedora"
[2025-10-13 06:48:03] VERSION_ID="7"
[2025-10-13 06:48:03] PRETTY_NAME="CentOS Linux 7 (Core)"
[2025-10-13 06:48:03] ANSI_COLOR="0;31"
[2025-10-13 06:48:03] CPE_NAME="cpe:/o:centos:centos:7"
[2025-10-13 06:48:03] HOME_URL="https://www.centos.org/"
[2025-10-13 06:48:03] BUG_REPORT_URL="https://bugs.centos.org/"
[2025-10-13 06:48:03] 
[2025-10-13 06:48:03] CENTOS_MANTISBT_PROJECT="CentOS-7"
[2025-10-13 06:48:03] CENTOS_MANTISBT_PROJECT_VERSION="7"
[2025-10-13 06:48:03] REDHAT_SUPPORT_PRODUCT="centos"
[2025-10-13 06:48:03] REDHAT_SUPPORT_PRODUCT_VERSION="7"
[2025-10-13 06:48:03] 
[2025-10-13 06:48:03] 2025-10-13 10:47:12,139 | INFO     | ***************************************
[2025-10-13 06:48:03] 2025-10-13 10:47:12,644 | INFO     | executing command: df -mP /tmp/boinchome/slots/0
[2025-10-13 06:48:03] 2025-10-13 10:47:12,691 | INFO     | sufficient remaining disk space (72979841024 B)
[2025-10-13 06:48:03] 2025-10-13 10:47:12,691 | WARNING  | since timefloor is set to 0, pilot was only allowed to run one job
[2025-10-13 06:48:03] 2025-10-13 10:47:12,693 | INFO     | current server update state: UPDATING_FINAL
[2025-10-13 06:48:03] 2025-10-13 10:47:12,693 | INFO     | update_server=False
[2025-10-13 06:48:03] 2025-10-13 10:47:12,693 | WARNING  | setting graceful_stop since proceed_with_getjob() returned False (pilot will end)
[2025-10-13 06:48:03] 2025-10-13 10:47:12,699 | WARNING  | data:copytool_out:received graceful stop - abort after this iteration
[2025-10-13 06:48:03] 2025-10-13 10:47:12,833 | WARNING  | job monitor detected an abort_job request (signal=args.signal)
[2025-10-13 06:48:03] 2025-10-13 10:47:12,834 | WARNING  | cannot recover job monitoring - aborting pilot
[2025-10-13 06:48:03] 2025-10-13 10:47:12,834 | WARNING  | job:job_monitor:received graceful stop - abort after this iteration
[2025-10-13 06:48:03] 2025-10-13 10:47:12,834 | INFO     | will abort loop
[2025-10-13 06:48:03] 2025-10-13 10:47:12,834 | INFO     | all payload control threads have been joined
[2025-10-13 06:48:03] 2025-10-13 10:47:12,934 | INFO     | all job control threads have been joined
[2025-10-13 06:48:03] 2025-10-13 10:47:13,504 | INFO     | all data control threads have been joined
[2025-10-13 06:48:03] 2025-10-13 10:47:13,700 | INFO     | [job] retrieve thread has finished
[2025-10-13 06:48:03] 2025-10-13 10:47:13,840 | INFO     | [job] job monitor thread has finished
[2025-10-13 06:48:03] 2025-10-13 10:47:13,840 | INFO     | [payload] control thread has finished
[2025-10-13 06:48:03] 2025-10-13 10:47:13,875 | WARNING  | job:queue_monitor:received graceful stop - abort after this iteration
[2025-10-13 06:48:03] 2025-10-13 10:47:13,941 | INFO     | [job] control thread has finished
[2025-10-13 06:48:03] 2025-10-13 10:47:14,247 | INFO     | [payload] validate_post thread has finished
[2025-10-13 06:48:03] 2025-10-13 10:47:14,264 | INFO     | [job] create_data_payload thread has finished
[2025-10-13 06:48:03] 2025-10-13 10:47:14,407 | INFO     | [payload] run_realtimelog thread has finished
[2025-10-13 06:48:03] 2025-10-13 10:47:14,444 | INFO     | [payload] failed_post thread has finished
[2025-10-13 06:48:03] 2025-10-13 10:47:14,511 | INFO     | [data] control thread has finished
[2025-10-13 06:48:03] 2025-10-13 10:47:14,712 | INFO     | [data] copytool_out thread has finished
[2025-10-13 06:48:03] 2025-10-13 10:47:14,813 | WARNING  | data:queue_monitoring:received graceful stop - abort after this iteration
[2025-10-13 06:48:03] 2025-10-13 10:47:14,816 | INFO     | [data] copytool_in thread has finished
[2025-10-13 06:48:03] 2025-10-13 10:47:14,881 | INFO     | [job] queue monitor thread has finished
[2025-10-13 06:48:03] 2025-10-13 10:47:15,055 | INFO     | [payload] validate_pre thread has finished
[2025-10-13 06:48:03] 2025-10-13 10:47:15,059 | INFO     | [job] validate thread has finished
[2025-10-13 06:48:03] 2025-10-13 10:47:15,060 | INFO     | [payload] execute_payloads thread has finished
[2025-10-13 06:48:03] 2025-10-13 10:47:18,822 | INFO     | [data] queue_monitor thread has finished
[2025-10-13 06:48:03] 2025-10-13 10:47:34,389 | INFO     | [monitor] cgroup control has ended
[2025-10-13 06:48:03] 2025-10-13 10:47:34,721 | INFO     | only monitor.control thread still running - safe to abort: ['<_MainThread(MainThread, started 140177611319104)>', '<ExcThread(monitor, started 140176852510464)>']
[2025-10-13 06:48:03] 2025-10-13 10:47:39,746 | INFO     | all workflow threads have been joined
[2025-10-13 06:48:03] 2025-10-13 10:47:39,780 | INFO     | end of generic workflow (traces error code: 0)
[2025-10-13 06:48:03] 2025-10-13 10:47:39,782 | INFO     | traces error code: 0
[2025-10-13 06:48:03] 2025-10-13 10:47:39,782 | INFO     | pilot has finished (exit code=0, shell exit code=0)
[2025-10-13 06:48:03] 2025-10-13 10:47:42,749 | INFO     | PID=422375 has CPU usage=3.9% CMD=/cvmfs/atlas.cern.ch/repo/ATLASLocalRootBase/x86_64/python/3.9.20-x86_64-centos7/bin/python3 pilot3/pilot.py -q BOINC_MCORE -i PR
[2025-10-13 06:48:03] 2025-10-13 10:47:42,750 | INFO     | .. there are 60 such processes running
[2025-10-13 06:48:03] 2025-10-13 10:47:42,750 | INFO     | found 0 job(s) in 20 queues
[2025-10-13 06:48:03] 2025-10-13 10:47:42,750 | WARNING  | pilot monitor received instruction that args.graceful_stop has been set
[2025-10-13 06:48:03] 2025-10-13 10:47:42,750 | WARNING  | will wait for a maximum of 300 s for threads to finish
[2025-10-13 06:48:03] 2025-10-13 10:47:42,750 | WARNING  | job_aborted has been set - aborting pilot monitoring
[2025-10-13 06:48:03] 2025-10-13 10:47:42,750 | INFO     | [monitor] control thread has ended
[2025-10-13 06:48:03] 2025-10-13 10:47:42,992 [wrapper] ==== pilot stdout END ====
[2025-10-13 06:48:03] 2025-10-13 10:47:43,015 [wrapper] ==== wrapper stdout RESUME ====
[2025-10-13 06:48:03] 2025-10-13 10:47:43,049 [wrapper] pilotpid: 422375
[2025-10-13 06:48:03] 2025-10-13 10:47:43,077 [wrapper] Pilot exit status: 0
[2025-10-13 06:48:03] 2025-10-13 10:47:43,108 [wrapper] pandaids: 6840181691 6840181691
[2025-10-13 06:48:03] 2025-10-13 10:47:43,264 [wrapper] cleanup supervisor_pilot   71891 422377
[2025-10-13 06:48:03] 2025-10-13 10:47:43,268 [wrapper] Test setup, not cleaning
[2025-10-13 06:48:03] 2025-10-13 10:47:43,271 [wrapper] apfmon messages muted
[2025-10-13 06:48:03] 2025-10-13 10:47:43,274 [wrapper] ==== wrapper stdout END ====
[2025-10-13 06:48:03] 2025-10-13 10:47:43,277 [wrapper] ==== wrapper stderr END ====
[2025-10-13 06:48:03]  *** Error codes and diagnostics ***
[2025-10-13 06:48:03]     "exeErrorCode": 0,
[2025-10-13 06:48:03]     "exeErrorDiag": "",
[2025-10-13 06:48:03]     "pilotErrorCode": 0,
[2025-10-13 06:48:03]     "pilotErrorDiag": "",
[2025-10-13 06:48:03]  *** Listing of results directory ***
[2025-10-13 06:48:03] total 629188
[2025-10-13 06:48:03] drwx------. 5 boincer umatlas      4096 Oct  7 03:00 pilot3
[2025-10-13 06:48:03] -rw-r--r--. 1 boincer umatlas    557409 Oct 12 09:55 pilot3.tar.gz
[2025-10-13 06:48:03] -rwx------. 1 boincer umatlas     36292 Oct 12 10:22 runpilot2-wrapper.sh
[2025-10-13 06:48:03] -rw-r--r--. 1 boincer umatlas      5112 Oct 12 10:22 queuedata.json
[2025-10-13 06:48:03] -rw-r--r--. 1 boincer umatlas       100 Oct 12 12:22 wrapper_26015_x86_64-pc-linux-gnu
[2025-10-13 06:48:03] -rwxr-xr-x. 1 boincer umatlas      7986 Oct 12 12:22 run_atlas
[2025-10-13 06:48:03] -rw-r--r--. 1 boincer umatlas       105 Oct 12 12:22 job.xml
[2025-10-13 06:48:03] -rw-r--r--. 3 boincer umatlas 218946687 Oct 12 12:22 EVNT.46676267._004228.pool.root.1
[2025-10-13 06:48:03] -rw-r--r--. 3 boincer umatlas 218946687 Oct 12 12:22 ATLAS.root_0
[2025-10-13 06:48:03] -rw-r--r--. 2 boincer umatlas     15120 Oct 12 12:22 start_atlas.sh
[2025-10-13 06:48:03] drwxrwx--x. 2 boincer umatlas      4096 Oct 12 12:22 shared
[2025-10-13 06:48:03] -rw-r--r--. 2 boincer umatlas    569677 Oct 12 12:22 input.tar.gz
[2025-10-13 06:48:03] -rw-r--r--. 1 boincer umatlas         0 Oct 12 12:22 boinc_lockfile
[2025-10-13 06:48:03] -rw-r--r--. 1 boincer umatlas      2550 Oct 12 22:45 pandaJob.out
[2025-10-13 06:48:03] -rw-------. 1 boincer umatlas    974373 Oct 12 22:45 agis_schedconf.cvmfs.json
[2025-10-13 06:48:03] -rw-r--r--. 1 boincer umatlas      6933 Oct 13 06:36 init_data.xml
[2025-10-13 06:48:03] -rw-------. 1 boincer umatlas 195105494 Oct 13 06:43 HITS.46676269._080566.pool.root.1
[2025-10-13 06:48:03] -rw-r--r--. 1 boincer umatlas       531 Oct 13 06:43 boinc_task_state.xml
[2025-10-13 06:48:03] -rw-------. 1 boincer umatlas      1049 Oct 13 06:46 memory_monitor_summary.json
[2025-10-13 06:48:03] -rw-------. 1 boincer umatlas   1560580 Oct 13 06:46 agis_ddmendpoints.agis.ALL.json
[2025-10-13 06:48:03] -rw-------. 1 boincer umatlas    615448 Oct 13 06:46 log.46676269._080566.job.log.tgz.1
[2025-10-13 06:48:03] -rw-------. 1 boincer umatlas        96 Oct 13 06:47 pilot_heartbeat.json
[2025-10-13 06:48:03] -rw-------. 1 boincer umatlas      7814 Oct 13 06:47 heartbeat.json
[2025-10-13 06:48:03] -rw-------. 1 boincer umatlas       822 Oct 13 06:47 pilotlog.txt
[2025-10-13 06:48:03] -rw-------. 1 boincer umatlas   3076412 Oct 13 06:47 log.46676269._080566.job.log.1
[2025-10-13 06:48:03] -rw-------. 1 boincer umatlas       357 Oct 13 06:47 output.list
[2025-10-13 06:48:03] -rw-r--r--. 1 boincer umatlas       620 Oct 13 06:47 runtime_log
[2025-10-13 06:48:03] -rw-------. 1 boincer umatlas   3706880 Oct 13 06:47 result.tar.gz
[2025-10-13 06:48:03] -rw-------. 1 boincer umatlas       910 Oct 13 06:47 ze0LDmZ9BS8n9Rq4apOajLDm4fhM0noT9bVof3QYDmH5TMDmR7NR2n.diag
[2025-10-13 06:48:03] -rw-r--r--. 1 boincer umatlas      8784 Oct 13 06:47 runtime_log.err
[2025-10-13 06:48:03] -rw-r--r--. 1 boincer umatlas        28 Oct 13 06:48 wrapper_checkpoint.txt
[2025-10-13 06:48:03] -rw-r--r--. 1 boincer umatlas      8192 Oct 13 06:48 boinc_mmap_file
[2025-10-13 06:48:03] -rw-r--r--. 1 boincer umatlas     25445 Oct 13 06:48 stderr.txt
[2025-10-13 06:48:03] HITS file was successfully produced:
[2025-10-13 06:48:03] -rw-------. 1 boincer umatlas 195105494 Oct 13 06:43 shared/HITS.pool.root.1
[2025-10-13 06:48:03]  *** Contents of shared directory: ***
[2025-10-13 06:48:03] total 408556
[2025-10-13 06:48:03] -rw-r--r--. 3 boincer umatlas 218946687 Oct 12 12:22 ATLAS.root_0
[2025-10-13 06:48:03] -rw-r--r--. 2 boincer umatlas     15120 Oct 12 12:22 start_atlas.sh
[2025-10-13 06:48:03] -rw-r--r--. 2 boincer umatlas    569677 Oct 12 12:22 input.tar.gz
[2025-10-13 06:48:03] -rw-------. 1 boincer umatlas 195105494 Oct 13 06:43 HITS.pool.root.1
[2025-10-13 06:48:03] -rw-------. 1 boincer umatlas   3706880 Oct 13 06:47 result.tar.gz
06:48:05 (399008): run_atlas exited; CPU time 33931.319260
06:48:05 (399008): called boinc_finish(0)

</stderr_txt>
]]>


©2025 CERN