| Name | KpgNDmIoH76n9Rq4apOajLDm4fhM0noT9bVoFjIUDmdFgKDmPt9y1n_0 |
| Workunit | 230560357 |
| Created | 25 Feb 2025, 21:38:37 UTC |
| Sent | 25 Feb 2025, 21:38:41 UTC |
| Report deadline | 5 Mar 2025, 21:38:41 UTC |
| Received | 26 Feb 2025, 2:03:36 UTC |
| Server state | Over |
| Outcome | Success |
| Client state | Done |
| Exit status | 0 (0x00000000) |
| Computer ID | 10857192 |
| Run time | 4 hours 23 min 5 sec |
| CPU time | 14 hours 15 min 26 sec |
| Validate state | Valid |
| Credit | 387.46 |
| Device peak FLOPS | 24.92 GFLOPS |
| Application version | ATLAS Simulation v3.01 (native_mt) x86_64-pc-linux-gnu |
| Peak working set size | 2.77 GB |
| Peak swap size | 31.65 GB |
| Peak disk usage | 661.40 MB |
Stderr output
<core_client_version>8.1.0</core_client_version>
<![CDATA[
<stderr_txt>
16:39:04 (3917284): wrapper (7.7.26015): starting
16:39:04 (3917284): wrapper: running run_atlas (--nthreads 10)
[2025-02-25 16:39:04] Arguments: --nthreads 10
[2025-02-25 16:39:04] Threads: 10
[2025-02-25 16:39:04] Checking for CVMFS
[2025-02-25 16:39:04] Probing /cvmfs/atlas.cern.ch... OK
[2025-02-25 16:39:05] Probing /cvmfs/atlas-condb.cern.ch... OK
[2025-02-25 16:39:05] Running cvmfs_config stat atlas.cern.ch
[2025-02-25 16:39:05] 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-02-25 16:39:05] 2.11.5.0 2557446 19233 259568 143052 3 285 22820809 37641216 16150 130560 0 3392710 99.036 7435233 29569 http://cvmfs-s1fnal.opensciencegrid.org:8000/cvmfs/atlas.cern.ch http://192.41.231.237:6081 1
[2025-02-25 16:39:05] CVMFS is ok
[2025-02-25 16:39:05] Efficiency of ATLAS tasks can be improved by the following measure(s):
[2025-02-25 16:39:05] The CVMFS client on this computer should be configured to use Cloudflare's openhtc.io.
[2025-02-25 16:39:05] Further information can be found at the LHC@home message board.
[2025-02-25 16:39:05] Using apptainer image /cvmfs/atlas.cern.ch/repo/containers/fs/singularity/x86_64-centos7
[2025-02-25 16:39:05] Checking for apptainer binary...
[2025-02-25 16:39:05] Using apptainer found in PATH at /usr/bin/apptainer
[2025-02-25 16:39:05] Running /usr/bin/apptainer --version
[2025-02-25 16:39:05] apptainer version 1.3.6-1.el9
[2025-02-25 16:39:05] Checking apptainer works with /usr/bin/apptainer exec -B /cvmfs /cvmfs/atlas.cern.ch/repo/containers/fs/singularity/x86_64-centos7 hostname
[2025-02-25 16:39:05] c-8-15.aglt2.org
[2025-02-25 16:39:05] apptainer works
[2025-02-25 16:39:05] Set ATHENA_PROC_NUMBER=10
[2025-02-25 16:39:05] Set ATHENA_CORE_NUMBER=10
[2025-02-25 16:39:05] Starting ATLAS job with PandaID=6531001387
[2025-02-25 16:39:05] Running command: /usr/bin/apptainer exec -B /cvmfs,/tmp/boinchome/slots/1 /cvmfs/atlas.cern.ch/repo/containers/fs/singularity/x86_64-centos7 sh start_atlas.sh
[2025-02-25 21:03:07] *** The last 200 lines of the pilot log: ***
[2025-02-25 21:03:07] 2025-02-26 02:02:52,522 | INFO | chi2: 5.721293757431575
[2025-02-25 21:03:07] 2025-02-26 02:02:52,523 | INFO | model: linear, x: [1740519590.0, 1740519651.0, 1740519712.0, 1740519773.0, 1740519834.0, 1740519895.0, 1740519956.0, 1740520017.0, 1740520078.0, 1740520139.0, 1740
[2025-02-25 21:03:07] 2025-02-26 02:02:52,524 | INFO | sum of square deviations: 5081472273.169256
[2025-02-25 21:03:07] 2025-02-26 02:02:52,526 | INFO | sum of deviations: 125352010738.86998
[2025-02-25 21:03:07] 2025-02-26 02:02:52,526 | INFO | mean x: 1740527306.6811023
[2025-02-25 21:03:07] 2025-02-26 02:02:52,526 | INFO | mean y: 2341010.0354330707
[2025-02-25 21:03:07] 2025-02-26 02:02:52,526 | INFO | -- intersect: -42933758196.95886
[2025-02-25 21:03:07] 2025-02-26 02:02:52,526 | INFO | intersect: -42933758196.95886
[2025-02-25 21:03:07] 2025-02-26 02:02:52,527 | INFO | chi2: 4.858256770211582
[2025-02-25 21:03:07] 2025-02-26 02:02:52,527 | INFO | current chi2=4.858256770211582 (change=15.084647350941665 %)
[2025-02-25 21:03:07] 2025-02-26 02:02:52,527 | INFO | right removable region: 253
[2025-02-25 21:03:07] 2025-02-26 02:02:52,527 | INFO | model: linear, x: [1740519895.0, 1740519956.0, 1740520017.0, 1740520078.0, 1740520139.0, 1740520200.0, 1740520261.0, 1740520322.0, 1740520383.0, 1740520444.0, 1740
[2025-02-25 21:03:07] 2025-02-26 02:02:52,528 | INFO | sum of square deviations: 5081444213.169256
[2025-02-25 21:03:07] 2025-02-26 02:02:52,529 | INFO | sum of deviations: 46409967759.36612
[2025-02-25 21:03:07] 2025-02-26 02:02:52,530 | INFO | mean x: 1740527611.6811023
[2025-02-25 21:03:07] 2025-02-26 02:02:52,530 | INFO | mean y: 2364727.2637795275
[2025-02-25 21:03:07] 2025-02-26 02:02:52,530 | INFO | -- intersect: -15894263662.960342
[2025-02-25 21:03:07] 2025-02-26 02:02:52,530 | INFO | intersect: -15894263662.960342
[2025-02-25 21:03:07] 2025-02-26 02:02:52,531 | INFO | chi2: 3.0707444550299483
[2025-02-25 21:03:07] 2025-02-26 02:02:52,531 | INFO | current chi2=3.0707444550299483 (change=46.327796033174174 %)
[2025-02-25 21:03:07] 2025-02-26 02:02:52,531 | INFO | model: linear, x: [1740520200.0, 1740520261.0, 1740520322.0, 1740520383.0, 1740520444.0, 1740520505.0, 1740520566.0, 1740520627.0, 1740520688.0, 1740520749.0, 1740
[2025-02-25 21:03:07] 2025-02-26 02:02:52,531 | INFO | sum of square deviations: 4787220015.502044
[2025-02-25 21:03:07] 2025-02-26 02:02:52,533 | INFO | sum of deviations: -376307642.9799061
[2025-02-25 21:03:07] 2025-02-26 02:02:52,533 | INFO | mean x: 1740527764.1847389
[2025-02-25 21:03:07] 2025-02-26 02:02:52,533 | INFO | mean y: 2388983.8473895583
[2025-02-25 21:03:07] 2025-02-26 02:02:52,534 | INFO | -- intersect: 139206155.05750713
[2025-02-25 21:03:07] 2025-02-26 02:02:52,534 | INFO | intersect: 139206155.05750713
[2025-02-25 21:03:07] 2025-02-26 02:02:52,534 | INFO | chi2: 1.716018638100118
[2025-02-25 21:03:07] 2025-02-26 02:02:52,534 | INFO | current chi2=1.716018638100118 (change=44.117178644115405 %)
[2025-02-25 21:03:07] 2025-02-26 02:02:52,535 | INFO | model: linear, x: [1740520505.0, 1740520566.0, 1740520627.0, 1740520688.0, 1740520749.0, 1740520810.0, 1740520871.0, 1740520932.0, 1740520993.0, 1740521054.0, 1740
[2025-02-25 21:03:07] 2025-02-26 02:02:52,535 | INFO | sum of square deviations: 4504577430.327843
[2025-02-25 21:03:07] 2025-02-26 02:02:52,537 | INFO | sum of deviations: -31317771883.295074
[2025-02-25 21:03:07] 2025-02-26 02:02:52,537 | INFO | mean x: 1740527916.6885245
[2025-02-25 21:03:07] 2025-02-26 02:02:52,537 | INFO | mean y: 2405592.680327869
[2025-02-25 21:03:07] 2025-02-26 02:02:52,537 | INFO | -- intersect: 12103308972.509861
[2025-02-25 21:03:07] 2025-02-26 02:02:52,537 | INFO | intersect: 12103308972.509861
[2025-02-25 21:03:07] 2025-02-26 02:02:52,538 | INFO | chi2: 0.9779828966854561
[2025-02-25 21:03:07] 2025-02-26 02:02:52,538 | INFO | current chi2=0.9779828966854561 (change=43.00860870787363 %)
[2025-02-25 21:03:07] 2025-02-26 02:02:52,538 | INFO | model: linear, x: [1740520810.0, 1740520871.0, 1740520932.0, 1740520993.0, 1740521054.0, 1740521115.0, 1740521176.0, 1740521237.0, 1740521298.0, 1740521359.0, 1740
[2025-02-25 21:03:07] 2025-02-26 02:02:52,538 | INFO | sum of square deviations: 4233283895.146445
[2025-02-25 21:03:07] 2025-02-26 02:02:52,540 | INFO | sum of deviations: -29034530800.53138
[2025-02-25 21:03:07] 2025-02-26 02:02:52,540 | INFO | mean x: 1740528069.1924686
[2025-02-25 21:03:07] 2025-02-26 02:02:52,540 | INFO | mean y: 2404302.8158995816
[2025-02-25 21:03:07] 2025-02-26 02:02:52,541 | INFO | -- intersect: 11940043517.634007
[2025-02-25 21:03:07] 2025-02-26 02:02:52,541 | INFO | intersect: 11940043517.634007
[2025-02-25 21:03:07] 2025-02-26 02:02:52,541 | INFO | chi2: 0.9767922132524804
[2025-02-25 21:03:07] 2025-02-26 02:02:52,541 | INFO | current chi2=0.9767922132524804 (change=0.1217489014389824 %)
[2025-02-25 21:03:07] 2025-02-26 02:02:52,541 | INFO | left removable region: 40
[2025-02-25 21:03:07] 2025-02-26 02:02:52,542 | INFO | model: linear, x: [1740522030.0, 1740522091.0, 1740522152.0, 1740522213.0, 1740522275.0, 1740522335.0, 1740522397.0, 1740522457.0, 1740522518.0, 1740522579.0, 1740
[2025-02-25 21:03:07] 2025-02-26 02:02:52,542 | INFO | sum of square deviations: 2996582214.319237
[2025-02-25 21:03:07] 2025-02-26 02:02:52,543 | INFO | sum of deviations: 1503437721.7511747
[2025-02-25 21:03:07] 2025-02-26 02:02:52,543 | INFO | mean x: 1740528496.2018778
[2025-02-25 21:03:07] 2025-02-26 02:02:52,544 | INFO | mean y: 2405846.1220657276
[2025-02-25 21:03:07] 2025-02-26 02:02:52,544 | INFO | -- intersect: -870847750.7485371
[2025-02-25 21:03:07] 2025-02-26 02:02:52,544 | INFO | intersect: -870847750.7485371
[2025-02-25 21:03:07] 2025-02-26 02:02:52,544 | INFO | chi2: 0.016287297262564338
[2025-02-25 21:03:07] 2025-02-26 02:02:52,544 | INFO | -- intersect: -870847750.7485371
[2025-02-25 21:03:07] 2025-02-26 02:02:52,544 | INFO | current memory leak: 0.50 B/s (using 213 data points, chi2=0.02)
[2025-02-25 21:03:07] 2025-02-26 02:02:52,545 | INFO | ..............................
[2025-02-25 21:03:07] 2025-02-26 02:02:52,546 | INFO | . Timing measurements:
[2025-02-25 21:03:07] 2025-02-26 02:02:52,546 | INFO | . get job = 0 s
[2025-02-25 21:03:07] 2025-02-26 02:02:52,546 | INFO | . initial setup = 3 s
[2025-02-25 21:03:07] 2025-02-26 02:02:52,546 | INFO | . payload setup = 7 s
[2025-02-25 21:03:07] 2025-02-26 02:02:52,546 | INFO | . stage-in = 0 s
[2025-02-25 21:03:07] 2025-02-26 02:02:52,546 | INFO | . payload execution = 15773 s
[2025-02-25 21:03:07] 2025-02-26 02:02:52,546 | INFO | . stage-out = 2 s
[2025-02-25 21:03:07] 2025-02-26 02:02:52,546 | INFO | . log creation = 0 s
[2025-02-25 21:03:07] 2025-02-26 02:02:52,546 | INFO | ..............................
[2025-02-25 21:03:07] 2025-02-26 02:02:52,655 | INFO |
[2025-02-25 21:03:07] 2025-02-26 02:02:52,655 | INFO | job summary report
[2025-02-25 21:03:07] 2025-02-26 02:02:52,655 | INFO | --------------------------------------------------
[2025-02-25 21:03:07] 2025-02-26 02:02:52,655 | INFO | PanDA job id: 6531001387
[2025-02-25 21:03:07] 2025-02-26 02:02:52,655 | INFO | task id: 43401171
[2025-02-25 21:03:07] 2025-02-26 02:02:52,656 | INFO | errors: (none)
[2025-02-25 21:03:07] 2025-02-26 02:02:52,656 | INFO | status: LOG_TRANSFER = DONE
[2025-02-25 21:03:07] 2025-02-26 02:02:52,656 | INFO | pilot state: finished
[2025-02-25 21:03:07] 2025-02-26 02:02:52,656 | INFO | transexitcode: 0
[2025-02-25 21:03:07] 2025-02-26 02:02:52,656 | INFO | exeerrorcode: 0
[2025-02-25 21:03:07] 2025-02-26 02:02:52,656 | INFO | exeerrordiag:
[2025-02-25 21:03:07] 2025-02-26 02:02:52,656 | INFO | exitcode: 0
[2025-02-25 21:03:07] 2025-02-26 02:02:52,656 | INFO | exitmsg: OK
[2025-02-25 21:03:07] 2025-02-26 02:02:52,656 | INFO | cpuconsumptiontime: 51167 s
[2025-02-25 21:03:07] 2025-02-26 02:02:52,656 | INFO | nevents: 400
[2025-02-25 21:03:07] 2025-02-26 02:02:52,657 | INFO | neventsw: 0
[2025-02-25 21:03:07] 2025-02-26 02:02:52,657 | INFO | pid: 3941011
[2025-02-25 21:03:07] 2025-02-26 02:02:52,657 | INFO | pgrp: 3941011
[2025-02-25 21:03:07] 2025-02-26 02:02:52,657 | INFO | corecount: 10
[2025-02-25 21:03:07] 2025-02-26 02:02:52,657 | INFO | event service: False
[2025-02-25 21:03:07] 2025-02-26 02:02:52,657 | INFO | sizes: {0: 2370214, 1: 2370413, 6: 2370619, 12: 2370647, 15784: 2401682, 15788: 2410623, 15790: 2410807, 15797: 2410977}
[2025-02-25 21:03:07] 2025-02-26 02:02:52,657 | INFO | --------------------------------------------------
[2025-02-25 21:03:07] 2025-02-26 02:02:52,657 | INFO |
[2025-02-25 21:03:07] 2025-02-26 02:02:52,657 | INFO | executing command: ls -lF /tmp/boinchome/slots/1
[2025-02-25 21:03:07] 2025-02-26 02:02:52,679 | INFO | queue jobs had 0 job(s) [purged]
[2025-02-25 21:03:07] 2025-02-26 02:02:52,679 | INFO | queue payloads had 0 job(s) [purged]
[2025-02-25 21:03:07] 2025-02-26 02:02:52,679 | INFO | queue data_in had 0 job(s) [purged]
[2025-02-25 21:03:07] 2025-02-26 02:02:52,679 | INFO | queue data_out had 0 job(s) [purged]
[2025-02-25 21:03:07] 2025-02-26 02:02:52,679 | INFO | queue current_data_in had 0 job(s) [purged]
[2025-02-25 21:03:07] 2025-02-26 02:02:52,680 | INFO | queue validated_jobs had 0 job(s) [purged]
[2025-02-25 21:03:07] 2025-02-26 02:02:52,680 | INFO | queue validated_payloads had 0 job(s) [purged]
[2025-02-25 21:03:07] 2025-02-26 02:02:52,680 | INFO | queue monitored_payloads had 0 job(s) [purged]
[2025-02-25 21:03:07] 2025-02-26 02:02:52,680 | INFO | queue finished_jobs had 0 job(s) [purged]
[2025-02-25 21:03:07] 2025-02-26 02:02:52,680 | INFO | queue finished_payloads had 0 job(s) [purged]
[2025-02-25 21:03:07] 2025-02-26 02:02:52,680 | INFO | queue finished_data_in had 1 job(s) [purged]
[2025-02-25 21:03:07] 2025-02-26 02:02:52,680 | INFO | queue finished_data_out had 0 job(s) [purged]
[2025-02-25 21:03:07] 2025-02-26 02:02:52,680 | INFO | queue failed_jobs had 0 job(s) [purged]
[2025-02-25 21:03:07] 2025-02-26 02:02:52,680 | INFO | queue failed_payloads had 0 job(s) [purged]
[2025-02-25 21:03:07] 2025-02-26 02:02:52,681 | INFO | queue failed_data_in had 0 job(s) [purged]
[2025-02-25 21:03:07] 2025-02-26 02:02:52,681 | INFO | queue failed_data_out had 0 job(s) [purged]
[2025-02-25 21:03:07] 2025-02-26 02:02:52,681 | INFO | queue completed_jobs had 0 job(s) [purged]
[2025-02-25 21:03:07] 2025-02-26 02:02:52,681 | INFO | queue completed_jobids has 1 job(s)
[2025-02-25 21:03:07] 2025-02-26 02:02:52,681 | INFO | queue realtimelog_payloads had 0 job(s) [purged]
[2025-02-25 21:03:07] 2025-02-26 02:02:52,681 | INFO | queue messages had 0 job(s) [purged]
[2025-02-25 21:03:07] 2025-02-26 02:02:52,681 | INFO | job 6531001387 has completed (purged errors)
[2025-02-25 21:03:07] 2025-02-26 02:02:52,681 | INFO | overall cleanup function is called
[2025-02-25 21:03:07] 2025-02-26 02:02:53,690 | INFO | --- collectZombieJob: --- 10, [3941011]
[2025-02-25 21:03:07] 2025-02-26 02:02:53,690 | INFO | zombie collector waiting for pid 3941011
[2025-02-25 21:03:07] 2025-02-26 02:02:53,690 | INFO | harmless exception when collecting zombies: [Errno 10] No child processes
[2025-02-25 21:03:07] 2025-02-26 02:02:53,690 | INFO | collected zombie processes
[2025-02-25 21:03:07] 2025-02-26 02:02:53,690 | INFO | will attempt to kill all subprocesses of pid=3941011
[2025-02-25 21:03:07] 2025-02-26 02:02:53,942 | INFO | process IDs to be killed: [3941011] (in reverse order)
[2025-02-25 21:03:07] 2025-02-26 02:02:54,028 | WARNING | found no corresponding commands to process id(s)
[2025-02-25 21:03:07] 2025-02-26 02:02:54,028 | INFO | Do not look for orphan processes in BOINC jobs
[2025-02-25 21:03:07] 2025-02-26 02:02:54,045 | INFO | did not find any defunct processes belonging to 3941011
[2025-02-25 21:03:07] 2025-02-26 02:02:54,062 | INFO | did not find any defunct processes belonging to 3941011
[2025-02-25 21:03:07] 2025-02-26 02:02:54,063 | INFO | ready for new job
[2025-02-25 21:03:07] 2025-02-26 02:02:54,063 | INFO | pilot has finished with previous job - re-establishing logging
[2025-02-25 21:03:07] 2025-02-26 02:02:54,065 | INFO | **************************************
[2025-02-25 21:03:07] 2025-02-26 02:02:54,065 | INFO | *** PanDA Pilot version 3.9.4.15 ***
[2025-02-25 21:03:07] 2025-02-26 02:02:54,065 | INFO | **************************************
[2025-02-25 21:03:07] 2025-02-26 02:02:54,065 | INFO |
[2025-02-25 21:03:07] 2025-02-26 02:02:54,081 | INFO | architecture information:
[2025-02-25 21:03:07] 2025-02-26 02:02:54,081 | INFO | executing command: cat /etc/os-release
[2025-02-25 21:03:07] 2025-02-26 02:02:54,097 | INFO | cat /etc/os-release:
[2025-02-25 21:03:07] NAME="CentOS Linux"
[2025-02-25 21:03:07] VERSION="7 (Core)"
[2025-02-25 21:03:07] ID="centos"
[2025-02-25 21:03:07] ID_LIKE="rhel fedora"
[2025-02-25 21:03:07] VERSION_ID="7"
[2025-02-25 21:03:07] PRETTY_NAME="CentOS Linux 7 (Core)"
[2025-02-25 21:03:07] ANSI_COLOR="0;31"
[2025-02-25 21:03:07] CPE_NAME="cpe:/o:centos:centos:7"
[2025-02-25 21:03:07] HOME_URL="https://www.centos.org/"
[2025-02-25 21:03:07] BUG_REPORT_URL="https://bugs.centos.org/"
[2025-02-25 21:03:07]
[2025-02-25 21:03:07] CENTOS_MANTISBT_PROJECT="CentOS-7"
[2025-02-25 21:03:07] CENTOS_MANTISBT_PROJECT_VERSION="7"
[2025-02-25 21:03:07] REDHAT_SUPPORT_PRODUCT="centos"
[2025-02-25 21:03:07] REDHAT_SUPPORT_PRODUCT_VERSION="7"
[2025-02-25 21:03:07]
[2025-02-25 21:03:07] 2025-02-26 02:02:54,098 | INFO | **************************************
[2025-02-25 21:03:07] 2025-02-26 02:02:54,601 | INFO | executing command: df -mP /tmp/boinchome/slots/1
[2025-02-25 21:03:07] 2025-02-26 02:02:54,619 | INFO | sufficient remaining disk space (75780587520 B)
[2025-02-25 21:03:07] 2025-02-26 02:02:54,619 | WARNING | since timefloor is set to 0, pilot was only allowed to run one job
[2025-02-25 21:03:07] 2025-02-26 02:02:54,620 | WARNING | setting graceful_stop since proceed_with_getjob() returned False (pilot will end)
[2025-02-25 21:03:07] 2025-02-26 02:02:54,620 | WARNING | job:job_monitor:received graceful stop - abort after this iteration
[2025-02-25 21:03:07] 2025-02-26 02:02:54,620 | WARNING | job:queue_monitor:received graceful stop - abort after this iteration
[2025-02-25 21:03:07] 2025-02-26 02:02:54,620 | INFO | aborting loop
[2025-02-25 21:03:07] 2025-02-26 02:02:54,621 | WARNING | data:copytool_out:received graceful stop - abort after this iteration
[2025-02-25 21:03:07] 2025-02-26 02:02:55,185 | INFO | all payload control threads have been joined
[2025-02-25 21:03:07] 2025-02-26 02:02:55,367 | INFO | PID=3922537 has CPU usage=10.5% 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
[2025-02-25 21:03:07] 2025-02-26 02:02:55,367 | INFO | .. there are 35 such processes running
[2025-02-25 21:03:07] 2025-02-26 02:02:55,368 | INFO | found 0 job(s) in 20 queues
[2025-02-25 21:03:07] 2025-02-26 02:02:55,368 | WARNING | pilot monitor received instruction that args.graceful_stop has been set
[2025-02-25 21:03:07] 2025-02-26 02:02:55,368 | WARNING | will wait for a maximum of 300 s for threads to finish
[2025-02-25 21:03:07] 2025-02-26 02:02:55,504 | INFO | all data control threads have been joined
[2025-02-25 21:03:07] 2025-02-26 02:02:55,626 | INFO | [job] retrieve thread has finished
[2025-02-25 21:03:07] 2025-02-26 02:02:55,626 | INFO | [job] job monitor thread has finished
[2025-02-25 21:03:07] 2025-02-26 02:02:55,627 | INFO | [job] queue monitor thread has finished
[2025-02-25 21:03:07] 2025-02-26 02:02:55,858 | INFO | [payload] validate_post thread has finished
[2025-02-25 21:03:07] 2025-02-26 02:02:55,858 | INFO | all job control threads have been joined
[2025-02-25 21:03:07] 2025-02-26 02:02:56,015 | INFO | [payload] validate_pre thread has finished
[2025-02-25 21:03:07] 2025-02-26 02:02:56,046 | INFO | [payload] failed_post thread has finished
[2025-02-25 21:03:07] 2025-02-26 02:02:56,054 | INFO | [job] create_data_payload thread has finished
[2025-02-25 21:03:07] 2025-02-26 02:02:56,110 | INFO | [payload] execute_payloads thread has finished
[2025-02-25 21:03:07] 2025-02-26 02:02:56,191 | INFO | [payload] control thread has finished
[2025-02-25 21:03:07] 2025-02-26 02:02:56,204 | INFO | [job] validate thread has finished
[2025-02-25 21:03:07] 2025-02-26 02:02:56,297 | WARNING | data:queue_monitoring:received graceful stop - abort after this iteration
[2025-02-25 21:03:07] 2025-02-26 02:02:56,505 | INFO | [data] control thread has finished
[2025-02-25 21:03:07] 2025-02-26 02:02:56,627 | INFO | [data] copytool_out thread has finished
[2025-02-25 21:03:07] 2025-02-26 02:02:56,769 | INFO | [data] copytool_in thread has finished
[2025-02-25 21:03:07] 2025-02-26 02:02:56,839 | INFO | [payload] run_realtimelog thread has finished
[2025-02-25 21:03:07] 2025-02-26 02:02:56,864 | INFO | [job] control thread has finished
[2025-02-25 21:03:07] 2025-02-26 02:03:00,305 | INFO | [data] queue_monitor thread has finished
[2025-02-25 21:03:07] 2025-02-26 02:03:01,906 | INFO | only monitor.control thread still running - safe to abort: ['<_MainThread(MainThread, started 140425056085824)>', '<ExcThread(monitor, started 140424350000896)>']
[2025-02-25 21:03:07] 2025-02-26 02:03:02,403 | WARNING | job_aborted has been set - aborting pilot monitoring
[2025-02-25 21:03:07] 2025-02-26 02:03:02,404 | INFO | [monitor] control thread has ended
[2025-02-25 21:03:07] 2025-02-26 02:03:06,932 | INFO | all workflow threads have been joined
[2025-02-25 21:03:07] 2025-02-26 02:03:06,932 | INFO | end of generic workflow (traces error code: 0)
[2025-02-25 21:03:07] 2025-02-26 02:03:06,932 | INFO | traces error code: 0
[2025-02-25 21:03:07] 2025-02-26 02:03:06,932 | INFO | pilot has finished (exit code=0, shell exit code=0)
[2025-02-25 21:03:07] 2025-02-26 02:03:07,055 [wrapper] ==== pilot stdout END ====
[2025-02-25 21:03:07] 2025-02-26 02:03:07,057 [wrapper] ==== wrapper stdout RESUME ====
[2025-02-25 21:03:07] 2025-02-26 02:03:07,060 [wrapper] pilotpid: 3922537
[2025-02-25 21:03:07] 2025-02-26 02:03:07,063 [wrapper] Pilot exit status: 0
[2025-02-25 21:03:07] 2025-02-26 02:03:07,072 [wrapper] pandaids: 6531001387
[2025-02-25 21:03:07] 2025-02-26 02:03:07,130 [wrapper] cleanup supervisor_pilot 1556546 3922538
[2025-02-25 21:03:07] 2025-02-26 02:03:07,133 [wrapper] Test setup, not cleaning
[2025-02-25 21:03:07] 2025-02-26 02:03:07,138 [wrapper] apfmon messages muted
[2025-02-25 21:03:07] 2025-02-26 02:03:07,140 [wrapper] ==== wrapper stdout END ====
[2025-02-25 21:03:07] 2025-02-26 02:03:07,143 [wrapper] ==== wrapper stderr END ====
[2025-02-25 21:03:07] *** Error codes and diagnostics ***
[2025-02-25 21:03:07] "exeErrorCode": 0,
[2025-02-25 21:03:07] "exeErrorDiag": "",
[2025-02-25 21:03:07] "pilotErrorCode": 0,
[2025-02-25 21:03:07] "pilotErrorDiag": "",
[2025-02-25 21:03:07] *** Listing of results directory ***
[2025-02-25 21:03:07] total 431024
[2025-02-25 21:03:07] -rw-r--r--. 1 boincer umatlas 491065 Feb 25 16:07 pilot3.tar.gz
[2025-02-25 21:03:07] -rwx------. 1 boincer umatlas 35865 Feb 25 16:38 runpilot2-wrapper.sh
[2025-02-25 21:03:07] -rw-r--r--. 1 boincer umatlas 5118 Feb 25 16:38 queuedata.json
[2025-02-25 21:03:07] -rw-r--r--. 1 boincer umatlas 100 Feb 25 16:39 wrapper_26015_x86_64-pc-linux-gnu
[2025-02-25 21:03:07] -rwxr-xr-x. 1 boincer umatlas 7986 Feb 25 16:39 run_atlas
[2025-02-25 21:03:07] -rw-r--r--. 1 boincer umatlas 105 Feb 25 16:39 job.xml
[2025-02-25 21:03:07] -rw-r--r--. 2 boincer umatlas 250807158 Feb 25 16:39 EVNT.43401169._000056.pool.root.1
[2025-02-25 21:03:07] -rw-r--r--. 2 boincer umatlas 17569 Feb 25 16:39 start_atlas.sh
[2025-02-25 21:03:07] drwxrwx--x. 2 boincer umatlas 4096 Feb 25 16:39 shared
[2025-02-25 21:03:07] -rw-r--r--. 2 boincer umatlas 503555 Feb 25 16:39 input.tar.gz
[2025-02-25 21:03:07] -rw-r--r--. 1 boincer umatlas 0 Feb 25 16:39 boinc_lockfile
[2025-02-25 21:03:07] -rw-r--r--. 1 boincer umatlas 2543 Feb 25 16:39 pandaJob.out
[2025-02-25 21:03:07] -rw-------. 1 boincer umatlas 467 Feb 25 16:39 setup.sh.local
[2025-02-25 21:03:07] -rw-------. 1 boincer umatlas 987482 Feb 25 16:39 agis_schedconf.cvmfs.json
[2025-02-25 21:03:07] drwx------. 4 boincer umatlas 4096 Feb 25 16:39 pilot3
[2025-02-25 21:03:07] -rw-r--r--. 1 boincer umatlas 6675 Feb 25 21:00 init_data.xml
[2025-02-25 21:03:07] -rw-------. 1 boincer umatlas 95 Feb 25 21:01 pilot_heartbeat.json
[2025-02-25 21:03:07] -rw-------. 1 boincer umatlas 182666501 Feb 25 21:02 HITS.43401171._001413.pool.root.1
[2025-02-25 21:03:07] -rw-r--r--. 1 boincer umatlas 531 Feb 25 21:02 boinc_task_state.xml
[2025-02-25 21:03:07] -rw-------. 1 boincer umatlas 1060 Feb 25 21:02 memory_monitor_summary.json
[2025-02-25 21:03:07] -rw-------. 1 boincer umatlas 1573632 Feb 25 21:02 agis_ddmendpoints.agis.ALL.json
[2025-02-25 21:03:07] -rw-------. 1 boincer umatlas 471250 Feb 25 21:02 log.43401171._001413.job.log.tgz.1
[2025-02-25 21:03:07] -rw-------. 1 boincer umatlas 7738 Feb 25 21:02 heartbeat.json
[2025-02-25 21:03:07] -rw-r--r--. 1 boincer umatlas 28 Feb 25 21:03 wrapper_checkpoint.txt
[2025-02-25 21:03:07] -rw-r--r--. 1 boincer umatlas 8192 Feb 25 21:03 boinc_mmap_file
[2025-02-25 21:03:07] -rw-------. 1 boincer umatlas 4611 Feb 25 21:03 pilotlog.txt
[2025-02-25 21:03:07] -rw-------. 1 boincer umatlas 1576809 Feb 25 21:03 log.43401171._001413.job.log.1
[2025-02-25 21:03:07] -rw-------. 1 boincer umatlas 357 Feb 25 21:03 output.list
[2025-02-25 21:03:07] -rw-r--r--. 1 boincer umatlas 620 Feb 25 21:03 runtime_log
[2025-02-25 21:03:07] -rw-------. 1 boincer umatlas 2068480 Feb 25 21:03 result.tar.gz
[2025-02-25 21:03:07] -rw-r--r--. 1 boincer umatlas 11411 Feb 25 21:03 runtime_log.err
[2025-02-25 21:03:07] -rw-------. 1 boincer umatlas 657 Feb 25 21:03 KpgNDmIoH76n9Rq4apOajLDm4fhM0noT9bVoFjIUDmdFgKDmPt9y1n.diag
[2025-02-25 21:03:07] -rw-r--r--. 1 boincer umatlas 21738 Feb 25 21:03 stderr.txt
[2025-02-25 21:03:07] HITS file was successfully produced:
[2025-02-25 21:03:07] -rw-------. 1 boincer umatlas 182666501 Feb 25 21:02 shared/HITS.pool.root.1
[2025-02-25 21:03:07] *** Contents of shared directory: ***
[2025-02-25 21:03:07] total 425856
[2025-02-25 21:03:07] -rw-r--r--. 2 boincer umatlas 250807158 Feb 25 16:39 ATLAS.root_0
[2025-02-25 21:03:07] -rw-r--r--. 2 boincer umatlas 17569 Feb 25 16:39 start_atlas.sh
[2025-02-25 21:03:07] -rw-r--r--. 2 boincer umatlas 503555 Feb 25 16:39 input.tar.gz
[2025-02-25 21:03:07] -rw-------. 1 boincer umatlas 182666501 Feb 25 21:02 HITS.pool.root.1
[2025-02-25 21:03:07] -rw-------. 1 boincer umatlas 2068480 Feb 25 21:03 result.tar.gz
21:03:08 (3917284): run_atlas exited; CPU time 51052.617362
21:03:08 (3917284): called boinc_finish(0)
</stderr_txt>
]]>
©2025 CERN