Stderr output

<core_client_version>7.20.2</core_client_version>
<![CDATA[
<stderr_txt>
16:59:52 (13216): wrapper (7.7.26015): starting
16:59:52 (13216): wrapper: running run_atlas (--nthreads 8)
[2026-01-09 16:59:52] Arguments: --nthreads 8
[2026-01-09 16:59:52] Threads: 8
[2026-01-09 16:59:52] Checking for CVMFS
[2026-01-09 16:59:52] Probing /cvmfs/atlas.cern.ch... OK
[2026-01-09 16:59:53] Probing /cvmfs/atlas-condb.cern.ch... OK
[2026-01-09 16:59:53] Running cvmfs_config stat atlas.cern.ch
[2026-01-09 16:59:53] 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
[2026-01-09 16:59:53] 2.11.2.0 27806 35609 96264 154948 0 57 14008796 25165824 0 130560 0 18122187 99.822 10688139 3932 http://s1cern-cvmfs.openhtc.io/cvmfs/atlas.cern.ch http://192.168.73.11:3128/ 1
[2026-01-09 16:59:53] CVMFS is ok
[2026-01-09 16:59:53] Using apptainer image /cvmfs/atlas.cern.ch/repo/containers/fs/singularity/x86_64-centos7
[2026-01-09 16:59:53] Checking for apptainer binary...
[2026-01-09 16:59:53] Using apptainer found in PATH at /usr/bin/apptainer
[2026-01-09 16:59:53] Running /usr/bin/apptainer --version
[2026-01-09 16:59:53] apptainer version 1.3.2-1.el7
[2026-01-09 16:59:53] Checking apptainer works with /usr/bin/apptainer exec -B /cvmfs /cvmfs/atlas.cern.ch/repo/containers/fs/singularity/x86_64-centos7 hostname
[2026-01-09 16:59:54] cg-vwn467.simple-grid.lan
[2026-01-09 16:59:54] apptainer works
[2026-01-09 16:59:54] Set ATHENA_PROC_NUMBER=8
[2026-01-09 16:59:54] Set ATHENA_CORE_NUMBER=8
[2026-01-09 16:59:54] Starting ATLAS job with PandaID=6963161952
[2026-01-09 16:59:54] Running command: /usr/bin/apptainer exec -B /cvmfs,/var/lib/boinc/slots/6 /cvmfs/atlas.cern.ch/repo/containers/fs/singularity/x86_64-centos7 sh start_atlas.sh
[2026-01-09 19:32:36]  *** The last 200 lines of the pilot log: ***
[2026-01-09 19:32:36] 2026-01-09 18:32:03,932 | INFO     | mean y: 2510875.2083333335
[2026-01-09 19:32:36] 2026-01-09 18:32:03,932 | INFO     | intersect: 6940255371.343143
[2026-01-09 19:32:36] 2026-01-09 18:32:03,932 | INFO     | chi2: 0.050578918747048146
[2026-01-09 19:32:36] 2026-01-09 18:32:03,933 | INFO     | current chi2=0.050578918747048146 (change=96.56682211387584 %)
[2026-01-09 19:32:36] 2026-01-09 18:32:03,933 | INFO     | sum of square deviations: 832722590.0
[2026-01-09 19:32:36] 2026-01-09 18:32:03,934 | INFO     | sum of deviations: -396533123.0000002
[2026-01-09 19:32:36] 2026-01-09 18:32:03,934 | INFO     | mean x: 1767979262.0
[2026-01-09 19:32:36] 2026-01-09 18:32:03,934 | INFO     | mean y: 2505505.2805755395
[2026-01-09 19:32:36] 2026-01-09 18:32:03,934 | INFO     | intersect: 844397326.8535864
[2026-01-09 19:32:36] 2026-01-09 18:32:03,934 | INFO     | chi2: 0.023225149265253812
[2026-01-09 19:32:36] 2026-01-09 18:32:03,935 | INFO     | current chi2=0.023225149265253812 (change=54.08136464639378 %)
[2026-01-09 19:32:36] 2026-01-09 18:32:03,935 | INFO     | sum of square deviations: 746051197.5
[2026-01-09 19:32:36] 2026-01-09 18:32:03,936 | INFO     | sum of deviations: 1410009876.0
[2026-01-09 19:32:36] 2026-01-09 18:32:03,936 | INFO     | mean x: 1767979414.5
[2026-01-09 19:32:36] 2026-01-09 18:32:03,936 | INFO     | mean y: 2502418.9402985075
[2026-01-09 19:32:36] 2026-01-09 18:32:03,936 | INFO     | intersect: -3338914957.458588
[2026-01-09 19:32:36] 2026-01-09 18:32:03,936 | INFO     | chi2: 0.0003064645234065495
[2026-01-09 19:32:36] 2026-01-09 18:32:03,937 | INFO     | current chi2=0.0003064645234065495 (change=98.68046263166525 %)
[2026-01-09 19:32:36] 2026-01-09 18:32:03,937 | INFO     | sum of square deviations: 665612480.0
[2026-01-09 19:32:36] 2026-01-09 18:32:03,938 | INFO     | sum of deviations: 1056955479.0
[2026-01-09 19:32:36] 2026-01-09 18:32:03,938 | INFO     | mean x: 1767979567.0
[2026-01-09 19:32:36] 2026-01-09 18:32:03,938 | INFO     | mean y: 2503086.6821705424
[2026-01-09 19:32:36] 2026-01-09 18:32:03,938 | INFO     | intersect: -2804949817.597355
[2026-01-09 19:32:36] 2026-01-09 18:32:03,938 | INFO     | chi2: 0.00020581551968615683
[2026-01-09 19:32:36] 2026-01-09 18:32:03,938 | INFO     | current chi2=0.00020581551968615683 (change=32.841975508817306 %)
[2026-01-09 19:32:36] 2026-01-09 18:32:03,939 | INFO     | sum of square deviations: 591173875.0
[2026-01-09 19:32:36] 2026-01-09 18:32:03,939 | INFO     | sum of deviations: 770642646.0000001
[2026-01-09 19:32:36] 2026-01-09 18:32:03,940 | INFO     | mean x: 1767979719.5
[2026-01-09 19:32:36] 2026-01-09 18:32:03,940 | INFO     | mean y: 2503673.370967742
[2026-01-09 19:32:36] 2026-01-09 18:32:03,940 | INFO     | intersect: -2302199945.525956
[2026-01-09 19:32:36] 2026-01-09 18:32:03,940 | INFO     | chi2: 0.00013726179850371135
[2026-01-09 19:32:36] 2026-01-09 18:32:03,940 | INFO     | current chi2=0.00013726179850371135 (change=33.30833422425161 %)
[2026-01-09 19:32:36] 2026-01-09 18:32:03,941 | INFO     | sum of square deviations: 522502820.0
[2026-01-09 19:32:36] 2026-01-09 18:32:03,941 | INFO     | sum of deviations: 546875552.9999999
[2026-01-09 19:32:36] 2026-01-09 18:32:03,941 | INFO     | mean x: 1767979872.0
[2026-01-09 19:32:36] 2026-01-09 18:32:03,941 | INFO     | mean y: 2504168.151260504
[2026-01-09 19:32:36] 2026-01-09 18:32:03,942 | INFO     | intersect: -1847945117.8312895
[2026-01-09 19:32:36] 2026-01-09 18:32:03,942 | INFO     | chi2: 8.522998317952413e-05
[2026-01-09 19:32:36] 2026-01-09 18:32:03,942 | INFO     | current chi2=8.522998317952413e-05 (change=37.906989338173624 %)
[2026-01-09 19:32:36] 2026-01-09 18:32:03,942 | INFO     | sum of square deviations: 459366752.5
[2026-01-09 19:32:36] 2026-01-09 18:32:03,943 | INFO     | sum of deviations: 402404281.49999994
[2026-01-09 19:32:36] 2026-01-09 18:32:03,943 | INFO     | mean x: 1767980024.5
[2026-01-09 19:32:36] 2026-01-09 18:32:03,943 | INFO     | mean y: 2504517.1666666665
[2026-01-09 19:32:36] 2026-01-09 18:32:03,943 | INFO     | intersect: -1546242159.847741
[2026-01-09 19:32:36] 2026-01-09 18:32:03,944 | INFO     | chi2: 6.75201062252649e-05
[2026-01-09 19:32:36] 2026-01-09 18:32:03,944 | INFO     | current chi2=6.75201062252649e-05 (change=20.778928134898297 %)
[2026-01-09 19:32:36] 2026-01-09 18:32:03,944 | INFO     | left removable region: 70
[2026-01-09 19:32:36] 2026-01-09 18:32:03,944 | INFO     | sum of square deviations: 120605052.0
[2026-01-09 19:32:36] 2026-01-09 18:32:03,945 | INFO     | sum of deviations: 85847984.00000001
[2026-01-09 19:32:36] 2026-01-09 18:32:03,945 | INFO     | mean x: 1767980909.0
[2026-01-09 19:32:36] 2026-01-09 18:32:03,945 | INFO     | mean y: 2504892.821917808
[2026-01-09 19:32:36] 2026-01-09 18:32:03,945 | INFO     | intersect: -1255963092.3180203
[2026-01-09 19:32:36] 2026-01-09 18:32:03,945 | INFO     | chi2: 2.9328330609550988e-05
[2026-01-09 19:32:36] 2026-01-09 18:32:03,945 | INFO     | current memory leak: 0.71 B/s (using 73 data points, chi2=0.00)
[2026-01-09 19:32:36] 2026-01-09 18:32:03,946 | INFO     | could have reported an average CPU frequency of 2250 MHz (8 samples)
[2026-01-09 19:32:36] 2026-01-09 18:32:03,946 | INFO     | ..............................
[2026-01-09 19:32:36] 2026-01-09 18:32:03,947 | INFO     | . Timing measurements:
[2026-01-09 19:32:36] 2026-01-09 18:32:03,947 | INFO     | . get job = 0 s
[2026-01-09 19:32:36] 2026-01-09 18:32:03,947 | INFO     | . initial setup = 1 s
[2026-01-09 19:32:36] 2026-01-09 18:32:03,947 | INFO     | . payload setup = 7 s
[2026-01-09 19:32:36] 2026-01-09 18:32:03,947 | INFO     | . stage-in = 0 s
[2026-01-09 19:32:36] 2026-01-09 18:32:03,947 | INFO     | . payload execution = 9075 s
[2026-01-09 19:32:36] 2026-01-09 18:32:03,947 | INFO     | . stage-out = 0 s
[2026-01-09 19:32:36] 2026-01-09 18:32:03,947 | INFO     | . log creation = 0 s
[2026-01-09 19:32:36] 2026-01-09 18:32:03,947 | INFO     | ..............................
[2026-01-09 19:32:36] 2026-01-09 18:32:04,215 | INFO     | 
[2026-01-09 19:32:36] 2026-01-09 18:32:04,215 | INFO     | job summary report
[2026-01-09 19:32:36] 2026-01-09 18:32:04,215 | INFO     | --------------------------------------------------
[2026-01-09 19:32:36] 2026-01-09 18:32:04,215 | INFO     | PanDA job id: 6963161952
[2026-01-09 19:32:36] 2026-01-09 18:32:04,216 | INFO     | task id: 47898826
[2026-01-09 19:32:36] 2026-01-09 18:32:04,216 | INFO     | errors: (none)
[2026-01-09 19:32:36] 2026-01-09 18:32:04,216 | INFO     | status: LOG_TRANSFER = DONE 
[2026-01-09 19:32:36] 2026-01-09 18:32:04,216 | INFO     | pilot state: finished 
[2026-01-09 19:32:36] 2026-01-09 18:32:04,216 | INFO     | transexitcode: 0
[2026-01-09 19:32:36] 2026-01-09 18:32:04,216 | INFO     | exeerrorcode: 0
[2026-01-09 19:32:36] 2026-01-09 18:32:04,216 | INFO     | exeerrordiag: 
[2026-01-09 19:32:36] 2026-01-09 18:32:04,216 | INFO     | exitcode: 0
[2026-01-09 19:32:36] 2026-01-09 18:32:04,216 | INFO     | exitmsg: OK
[2026-01-09 19:32:36] 2026-01-09 18:32:04,217 | INFO     | cpuconsumptiontime: 68901 s
[2026-01-09 19:32:36] 2026-01-09 18:32:04,217 | INFO     | nevents: 400
[2026-01-09 19:32:36] 2026-01-09 18:32:04,217 | INFO     | neventsw: 0
[2026-01-09 19:32:36] 2026-01-09 18:32:04,217 | INFO     | pid: 23370
[2026-01-09 19:32:36] 2026-01-09 18:32:04,217 | INFO     | pgrp: 23370
[2026-01-09 19:32:36] 2026-01-09 18:32:04,217 | INFO     | corecount: 8
[2026-01-09 19:32:36] 2026-01-09 18:32:04,217 | INFO     | event service: False
[2026-01-09 19:32:36] 2026-01-09 18:32:04,217 | INFO     | sizes: {0: 2283800, 1: 2283999, 7: 2284261, 12: 2284289, 9087: 2312140, 9088: 2321138, 9090: 2321322, 9097: 2321516}
[2026-01-09 19:32:36] 2026-01-09 18:32:04,217 | INFO     | --------------------------------------------------
[2026-01-09 19:32:36] 2026-01-09 18:32:04,217 | INFO     | 
[2026-01-09 19:32:36] 2026-01-09 18:32:04,218 | INFO     | executing command: ls -lF /var/lib/boinc/slots/6
[2026-01-09 19:32:36] 2026-01-09 18:32:04,242 | INFO     | queue jobs had 0 job(s) [purged]
[2026-01-09 19:32:36] 2026-01-09 18:32:04,242 | INFO     | queue payloads had 0 job(s) [purged]
[2026-01-09 19:32:36] 2026-01-09 18:32:04,242 | INFO     | queue data_in had 0 job(s) [purged]
[2026-01-09 19:32:36] 2026-01-09 18:32:04,242 | INFO     | queue data_out had 0 job(s) [purged]
[2026-01-09 19:32:36] 2026-01-09 18:32:04,243 | INFO     | queue current_data_in had 0 job(s) [purged]
[2026-01-09 19:32:36] 2026-01-09 18:32:04,243 | INFO     | queue validated_jobs had 0 job(s) [purged]
[2026-01-09 19:32:36] 2026-01-09 18:32:04,243 | INFO     | queue validated_payloads had 0 job(s) [purged]
[2026-01-09 19:32:36] 2026-01-09 18:32:04,243 | INFO     | queue monitored_payloads had 0 job(s) [purged]
[2026-01-09 19:32:36] 2026-01-09 18:32:04,243 | INFO     | queue finished_jobs had 0 job(s) [purged]
[2026-01-09 19:32:36] 2026-01-09 18:32:04,243 | INFO     | queue finished_payloads had 0 job(s) [purged]
[2026-01-09 19:32:36] 2026-01-09 18:32:04,243 | INFO     | queue finished_data_in had 1 job(s) [purged]
[2026-01-09 19:32:36] 2026-01-09 18:32:04,243 | INFO     | queue finished_data_out had 0 job(s) [purged]
[2026-01-09 19:32:36] 2026-01-09 18:32:04,243 | INFO     | queue failed_jobs had 0 job(s) [purged]
[2026-01-09 19:32:36] 2026-01-09 18:32:04,244 | INFO     | queue failed_payloads had 0 job(s) [purged]
[2026-01-09 19:32:36] 2026-01-09 18:32:04,244 | INFO     | queue failed_data_in had 0 job(s) [purged]
[2026-01-09 19:32:36] 2026-01-09 18:32:04,244 | INFO     | queue failed_data_out had 0 job(s) [purged]
[2026-01-09 19:32:36] 2026-01-09 18:32:04,244 | INFO     | queue completed_jobs had 0 job(s) [purged]
[2026-01-09 19:32:36] 2026-01-09 18:32:04,244 | INFO     | queue completed_jobids has 1 job(s)
[2026-01-09 19:32:36] 2026-01-09 18:32:04,244 | INFO     | queue realtimelog_payloads had 0 job(s) [purged]
[2026-01-09 19:32:36] 2026-01-09 18:32:04,244 | INFO     | queue messages had 0 job(s) [purged]
[2026-01-09 19:32:36] 2026-01-09 18:32:04,244 | INFO     | job 6963161952 has completed (purged errors)
[2026-01-09 19:32:36] 2026-01-09 18:32:04,245 | INFO     | overall cleanup function is called
[2026-01-09 19:32:36] 2026-01-09 18:32:05,253 | INFO     | --- collectZombieJob: --- 10, [23370]
[2026-01-09 19:32:36] 2026-01-09 18:32:05,253 | INFO     | zombie collector waiting for pid 23370
[2026-01-09 19:32:36] 2026-01-09 18:32:05,253 | INFO     | harmless exception when collecting zombies: [Errno 10] No child processes
[2026-01-09 19:32:36] 2026-01-09 18:32:05,253 | INFO     | collected zombie processes
[2026-01-09 19:32:36] 2026-01-09 18:32:05,254 | INFO     | will attempt to kill all subprocesses of pid=23370
[2026-01-09 19:32:36] 2026-01-09 18:32:05,316 | INFO     | process IDs to be killed: [23370] (in reverse order)
[2026-01-09 19:32:36] 2026-01-09 18:32:05,360 | WARNING  | found no corresponding commands to process id(s)
[2026-01-09 19:32:36] 2026-01-09 18:32:05,361 | INFO     | Do not look for orphan processes in BOINC jobs
[2026-01-09 19:32:36] 2026-01-09 18:32:05,362 | INFO     | did not find any defunct processes belonging to 23370
[2026-01-09 19:32:36] 2026-01-09 18:32:05,364 | INFO     | did not find any defunct processes belonging to 23370
[2026-01-09 19:32:36] 2026-01-09 18:32:05,364 | INFO     | ready for new job
[2026-01-09 19:32:36] 2026-01-09 18:32:05,364 | INFO     | pilot has finished with previous job - re-establishing logging
[2026-01-09 19:32:36] 2026-01-09 18:32:05,366 | INFO     | ***************************************
[2026-01-09 19:32:36] 2026-01-09 18:32:05,366 | INFO     | ***  PanDA Pilot version 3.11.2.19  ***
[2026-01-09 19:32:36] 2026-01-09 18:32:05,366 | INFO     | ***************************************
[2026-01-09 19:32:36] 2026-01-09 18:32:05,366 | INFO     | 
[2026-01-09 19:32:36] 2026-01-09 18:32:05,367 | INFO     | pilot is running in a VM
[2026-01-09 19:32:36] 2026-01-09 18:32:05,367 | INFO     | architecture information:
[2026-01-09 19:32:36] 2026-01-09 18:32:05,368 | INFO     | executing command: cat /etc/os-release
[2026-01-09 19:32:36] 2026-01-09 18:32:05,389 | INFO     | cat /etc/os-release:
[2026-01-09 19:32:36] NAME="CentOS Linux"
[2026-01-09 19:32:36] VERSION="7 (Core)"
[2026-01-09 19:32:36] ID="centos"
[2026-01-09 19:32:36] ID_LIKE="rhel fedora"
[2026-01-09 19:32:36] VERSION_ID="7"
[2026-01-09 19:32:36] PRETTY_NAME="CentOS Linux 7 (Core)"
[2026-01-09 19:32:36] ANSI_COLOR="0;31"
[2026-01-09 19:32:36] CPE_NAME="cpe:/o:centos:centos:7"
[2026-01-09 19:32:36] HOME_URL="https://www.centos.org/"
[2026-01-09 19:32:36] BUG_REPORT_URL="https://bugs.centos.org/"
[2026-01-09 19:32:36] 
[2026-01-09 19:32:36] CENTOS_MANTISBT_PROJECT="CentOS-7"
[2026-01-09 19:32:36] CENTOS_MANTISBT_PROJECT_VERSION="7"
[2026-01-09 19:32:36] REDHAT_SUPPORT_PRODUCT="centos"
[2026-01-09 19:32:36] REDHAT_SUPPORT_PRODUCT_VERSION="7"
[2026-01-09 19:32:36] 
[2026-01-09 19:32:36] 2026-01-09 18:32:05,390 | INFO     | ***************************************
[2026-01-09 19:32:36] 2026-01-09 18:32:05,893 | INFO     | executing command: df -mP /var/lib/boinc/slots/6
[2026-01-09 19:32:36] 2026-01-09 18:32:05,934 | INFO     | sufficient remaining disk space (497871224832 B)
[2026-01-09 19:32:36] 2026-01-09 18:32:05,934 | WARNING  | since timefloor is set to 0, pilot was only allowed to run one job
[2026-01-09 19:32:36] 2026-01-09 18:32:05,935 | INFO     | current server update state: UPDATING_FINAL
[2026-01-09 19:32:36] 2026-01-09 18:32:05,935 | INFO     | update_server=False
[2026-01-09 19:32:36] 2026-01-09 18:32:05,935 | WARNING  | setting graceful_stop since proceed_with_getjob() returned False (pilot will end)
[2026-01-09 19:32:36] 2026-01-09 18:32:05,935 | WARNING  | job:queue_monitor:received graceful stop - abort after this iteration
[2026-01-09 19:32:36] 2026-01-09 18:32:05,936 | WARNING  | data:copytool_out:received graceful stop - abort after this iteration
[2026-01-09 19:32:36] 2026-01-09 18:32:06,125 | INFO     | all job control threads have been joined
[2026-01-09 19:32:36] 2026-01-09 18:32:06,184 | WARNING  | job:job_monitor:received graceful stop - abort after this iteration
[2026-01-09 19:32:36] 2026-01-09 18:32:06,185 | INFO     | aborting loop
[2026-01-09 19:32:36] 2026-01-09 18:32:06,363 | INFO     | all payload control threads have been joined
[2026-01-09 19:32:36] 2026-01-09 18:32:06,941 | INFO     | [job] retrieve thread has finished
[2026-01-09 19:32:36] 2026-01-09 18:32:06,942 | INFO     | [job] queue monitor thread has finished
[2026-01-09 19:32:36] 2026-01-09 18:32:07,020 | INFO     | all data control threads have been joined
[2026-01-09 19:32:36] 2026-01-09 18:32:07,051 | INFO     | [payload] run_realtimelog thread has finished
[2026-01-09 19:32:36] 2026-01-09 18:32:07,130 | INFO     | [job] control thread has finished
[2026-01-09 19:32:36] 2026-01-09 18:32:07,190 | INFO     | [job] job monitor thread has finished
[2026-01-09 19:32:36] 2026-01-09 18:32:07,207 | INFO     | [job] validate thread has finished
[2026-01-09 19:32:36] 2026-01-09 18:32:07,209 | WARNING  | data:queue_monitoring:received graceful stop - abort after this iteration
[2026-01-09 19:32:36] 2026-01-09 18:32:07,281 | INFO     | [payload] validate_post thread has finished
[2026-01-09 19:32:36] 2026-01-09 18:32:07,369 | INFO     | [payload] control thread has finished
[2026-01-09 19:32:36] 2026-01-09 18:32:07,737 | INFO     | [data] copytool_in thread has finished
[2026-01-09 19:32:36] 2026-01-09 18:32:07,862 | INFO     | [payload] execute_payloads thread has finished
[2026-01-09 19:32:36] 2026-01-09 18:32:07,942 | INFO     | [data] copytool_out thread has finished
[2026-01-09 19:32:36] 2026-01-09 18:32:07,959 | INFO     | [job] create_data_payload thread has finished
[2026-01-09 19:32:36] 2026-01-09 18:32:08,011 | INFO     | [payload] failed_post thread has finished
[2026-01-09 19:32:36] 2026-01-09 18:32:08,026 | INFO     | [data] control thread has finished
[2026-01-09 19:32:36] 2026-01-09 18:32:08,086 | INFO     | [payload] validate_pre thread has finished
[2026-01-09 19:32:36] 2026-01-09 18:32:11,215 | INFO     | [data] queue_monitor thread has finished
[2026-01-09 19:32:36] 2026-01-09 18:32:24,638 | INFO     | [monitor] cgroup control has ended
[2026-01-09 19:32:36] 2026-01-09 18:32:25,814 | INFO     | only monitor.control thread still running - safe to abort: ['<_MainThread(MainThread, started 140472450660160)>', '<ExcThread(monitor, started 140471863076608)>']
[2026-01-09 19:32:36] 2026-01-09 18:32:30,836 | INFO     | all workflow threads have been joined
[2026-01-09 19:32:36] 2026-01-09 18:32:30,837 | INFO     | end of generic workflow (traces error code: 0)
[2026-01-09 19:32:36] 2026-01-09 18:32:30,837 | INFO     | traces error code: 0
[2026-01-09 19:32:36] 2026-01-09 18:32:30,837 | INFO     | pilot has finished (exit code=0, shell exit code=0)
[2026-01-09 19:32:36] 2026-01-09 18:32:35,764 | INFO     | PID=16946 has CPU usage=1.2% 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 
[2026-01-09 19:32:36] 2026-01-09 18:32:35,764 | INFO     | found 0 job(s) in 20 queues
[2026-01-09 19:32:36] 2026-01-09 18:32:35,764 | WARNING  | pilot monitor received instruction that args.graceful_stop has been set
[2026-01-09 19:32:36] 2026-01-09 18:32:35,764 | WARNING  | will wait for a maximum of 300 s for threads to finish
[2026-01-09 19:32:36] 2026-01-09 18:32:35,764 | WARNING  | job_aborted has been set - aborting pilot monitoring
[2026-01-09 19:32:36] 2026-01-09 18:32:35,765 | INFO     | [monitor] control thread has ended
[2026-01-09 19:32:36] 2026-01-09 18:32:35,923 [wrapper] ==== pilot stdout END ====
[2026-01-09 19:32:36] 2026-01-09 18:32:35,931 [wrapper] ==== wrapper stdout RESUME ====
[2026-01-09 19:32:36] 2026-01-09 18:32:35,939 [wrapper] pilotpid: 16946
[2026-01-09 19:32:36] 2026-01-09 18:32:35,944 [wrapper] Pilot exit status: 0
[2026-01-09 19:32:36] 2026-01-09 18:32:35,968 [wrapper] pandaids: 6963161952
[2026-01-09 19:32:36] 2026-01-09 18:32:35,999 [wrapper] cleanup supervisor_pilot  7801 16947
[2026-01-09 19:32:36] 2026-01-09 18:32:36,004 [wrapper] Test setup, not cleaning
[2026-01-09 19:32:36] 2026-01-09 18:32:36,008 [wrapper] apfmon messages muted
[2026-01-09 19:32:36] 2026-01-09 18:32:36,013 [wrapper] ==== wrapper stdout END ====
[2026-01-09 19:32:36] 2026-01-09 18:32:36,017 [wrapper] ==== wrapper stderr END ====
[2026-01-09 19:32:36]  *** Error codes and diagnostics ***
[2026-01-09 19:32:36]     "exeErrorCode": 0,
[2026-01-09 19:32:36]     "exeErrorDiag": "",
[2026-01-09 19:32:36]     "pilotErrorCode": 0,
[2026-01-09 19:32:36]     "pilotErrorDiag": "",
[2026-01-09 19:32:36]  *** Listing of results directory ***
[2026-01-09 19:32:36] total 441140
[2026-01-09 19:32:36] -rw-r--r--. 1 boinc boinc    579449 Jan  8 22:44 pilot3.tar.gz
[2026-01-09 19:32:36] -rwx------. 1 boinc boinc     36322 Jan  8 22:49 runpilot2-wrapper.sh
[2026-01-09 19:32:36] -rw-r--r--. 1 boinc boinc      5112 Jan  8 22:51 queuedata.json
[2026-01-09 19:32:36] -rw-r--r--. 1 boinc boinc       100 Jan  9 16:59 wrapper_26015_x86_64-pc-linux-gnu
[2026-01-09 19:32:36] -rwxr-xr-x. 1 boinc boinc      7986 Jan  9 16:59 run_atlas
[2026-01-09 19:32:36] -rw-r--r--. 1 boinc boinc       105 Jan  9 16:59 job.xml
[2026-01-09 19:32:36] -rw-r--r--. 2 boinc boinc 224359118 Jan  9 16:59 EVNT.47898824._001233.pool.root.1
[2026-01-09 19:32:36] drwxrwx--x. 2 boinc boinc        68 Jan  9 16:59 shared
[2026-01-09 19:32:36] -rw-r--r--. 2 boinc boinc    592400 Jan  9 16:59 input.tar.gz
[2026-01-09 19:32:36] -rw-r--r--. 1 boinc boinc      6390 Jan  9 16:59 init_data.xml
[2026-01-09 19:32:36] -rw-r--r--. 2 boinc boinc     15847 Jan  9 16:59 start_atlas.sh
[2026-01-09 19:32:36] -rw-r--r--. 1 boinc boinc         0 Jan  9 16:59 boinc_lockfile
[2026-01-09 19:32:36] -rw-r--r--. 1 boinc boinc      2520 Jan  9 16:59 pandaJob.out
[2026-01-09 19:32:36] -rw-------. 1 boinc boinc    989377 Jan  9 17:00 agis_schedconf.cvmfs.json
[2026-01-09 19:32:36] -rw-------. 1 boinc boinc   1516240 Jan  9 17:00 agis_ddmendpoints.agis.ALL.json
[2026-01-09 19:32:36] drwx------. 5 boinc boinc      4096 Jan  9 17:00 pilot3
[2026-01-09 19:32:36] -rw-------. 1 boinc boinc 220253913 Jan  9 19:31 HITS.47898826._033609.pool.root.1
[2026-01-09 19:32:36] -rw-r--r--. 1 boinc boinc       529 Jan  9 19:31 boinc_task_state.xml
[2026-01-09 19:32:36] -rw-------. 1 boinc boinc      1014 Jan  9 19:31 memory_monitor_summary.json
[2026-01-09 19:32:36] -rw-------. 1 boinc boinc    383154 Jan  9 19:31 log.47898826._033609.job.log.tgz.1
[2026-01-09 19:32:36] -rw-------. 1 boinc boinc        95 Jan  9 19:31 pilot_heartbeat.json
[2026-01-09 19:32:36] -rw-------. 1 boinc boinc      7769 Jan  9 19:32 heartbeat.json
[2026-01-09 19:32:36] -rw-r--r--. 1 boinc boinc      8192 Jan  9 19:32 boinc_mmap_file
[2026-01-09 19:32:36] -rw-r--r--. 1 boinc boinc        27 Jan  9 19:32 wrapper_checkpoint.txt
[2026-01-09 19:32:36] -rw-------. 1 boinc boinc       745 Jan  9 19:32 pilotlog.txt
[2026-01-09 19:32:36] -rw-------. 1 boinc boinc   1228378 Jan  9 19:32 log.47898826._033609.job.log.1
[2026-01-09 19:32:36] -rw-------. 1 boinc boinc       357 Jan  9 19:32 output.list
[2026-01-09 19:32:36] -rw-r--r--. 1 boinc boinc       620 Jan  9 19:32 runtime_log
[2026-01-09 19:32:36] -rw-------. 1 boinc boinc   1628160 Jan  9 19:32 result.tar.gz
[2026-01-09 19:32:36] -rw-------. 1 boinc boinc       652 Jan  9 19:32 ZfyLDml3Cy8n9Rq4apOajLDm4fhM0noT9bVo0NGKDm5QgKDmOAaUXn.diag
[2026-01-09 19:32:36] -rw-r--r--. 1 boinc boinc      8816 Jan  9 19:32 runtime_log.err
[2026-01-09 19:32:36] -rw-r--r--. 1 boinc boinc     20629 Jan  9 19:32 stderr.txt
[2026-01-09 19:32:36] HITS file was successfully produced:
[2026-01-09 19:32:36] -rw-------. 1 boinc boinc 220253913 Jan  9 19:31 shared/HITS.pool.root.1
[2026-01-09 19:32:36]  *** Contents of shared directory: ***
[2026-01-09 19:32:36] total 436384
[2026-01-09 19:32:36] -rw-r--r--. 2 boinc boinc 224359118 Jan  9 16:59 ATLAS.root_0
[2026-01-09 19:32:36] -rw-r--r--. 2 boinc boinc    592400 Jan  9 16:59 input.tar.gz
[2026-01-09 19:32:36] -rw-r--r--. 2 boinc boinc     15847 Jan  9 16:59 start_atlas.sh
[2026-01-09 19:32:36] -rw-------. 1 boinc boinc 220253913 Jan  9 19:31 HITS.pool.root.1
[2026-01-09 19:32:36] -rw-------. 1 boinc boinc   1628160 Jan  9 19:32 result.tar.gz
19:32:37 (13216): run_atlas exited; CPU time 68955.995559
19:32:37 (13216): called boinc_finish(0)

</stderr_txt>
]]>

©2026 CERN