Name | VZzLDmZbCS8n9Rq4apOajLDm4fhM0noT9bVof3QYDmPAUMDmNZgetm_2 |
Workunit | 235935029 |
Created | 12 Oct 2025, 19:30:10 UTC |
Sent | 12 Oct 2025, 21:00:34 UTC |
Report deadline | 20 Oct 2025, 21:00:34 UTC |
Received | 12 Oct 2025, 23:43:10 UTC |
Server state | Over |
Outcome | Success |
Client state | Done |
Exit status | 0 (0x00000000) |
Computer ID | 10943883 |
Run time | 47 min 32 sec |
CPU time | 5 hours 34 min 3 sec |
Validate state | Valid |
Credit | 52.83 |
Device peak FLOPS | 8.00 GFLOPS |
Application version | ATLAS Simulation v3.01 (native_mt) x86_64-pc-linux-gnu |
Peak working set size | 1.91 GB |
Peak swap size | 3.01 GB |
Peak disk usage | 626.21 MB |
<core_client_version>8.3.0</core_client_version> <![CDATA[ <stderr_txt> 00:54:46 (9711): wrapper (7.7.26015): starting 00:54:46 (9711): wrapper: running run_atlas (--nthreads 8) [2025-10-13 00:54:46] Arguments: --nthreads 8 [2025-10-13 00:54:46] Threads: 8 [2025-10-13 00:54:46] Checking for CVMFS [2025-10-13 00:54:46] Probing /cvmfs/atlas.cern.ch... OK [2025-10-13 00:54:47] Probing /cvmfs/atlas-condb.cern.ch... OK [2025-10-13 00:54:47] Running cvmfs_config stat atlas.cern.ch [2025-10-13 00:54:47] 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-13 00:54:47] 2.11.0.0 8040 1520 65072 151640 1 188 1972507 4096000 917 130560 0 1299815 99.491 721800 1033 http://cvmfs-stratum-one.cern.ch/cvmfs/atlas.cern.ch http://141.99.253.245:3128 1 [2025-10-13 00:54:47] CVMFS is ok [2025-10-13 00:54:47] Efficiency of ATLAS tasks can be improved by the following measure(s): [2025-10-13 00:54:47] The CVMFS client on this computer should be configured to use Cloudflare's openhtc.io. [2025-10-13 00:54:47] Further information can be found at the LHC@home message board. [2025-10-13 00:54:47] Using apptainer image /cvmfs/atlas.cern.ch/repo/containers/fs/singularity/x86_64-centos7 [2025-10-13 00:54:47] Checking for apptainer binary... [2025-10-13 00:54:47] /usr/bin/which: no apptainer in (/opt/ohpc/pub/libs/singularity/3.7.1/bin:/cm/shared/apps/slurm/current/sbin:/cm/shared/apps/slurm/current/bin:/home/mf493845/.local/bin:/home/mf493845/bin:/usr/local/bin:/usr/bin:/usr/local/sbin:/usr/sbin) [2025-10-13 00:54:47] apptainer is not installed, using version from CVMFS [2025-10-13 00:54:47] Checking apptainer works with /cvmfs/atlas.cern.ch/repo/containers/sw/apptainer/x86_64-el7/current/bin/apptainer exec -B /cvmfs /cvmfs/atlas.cern.ch/repo/containers/fs/singularity/x86_64-centos7 hostname [2025-10-13 00:54:47] WARNING: Environment variable TMPDIR already has value [/tmp/job_10534167/atlas/pilot/slots/0/.apptainertmp], will not forward new value [/tmp] from parent process environment hpc-node071 [2025-10-13 00:54:47] apptainer works [2025-10-13 00:54:47] Set ATHENA_PROC_NUMBER=8 [2025-10-13 00:54:47] Set ATHENA_CORE_NUMBER=8 [2025-10-13 00:54:47] Starting ATLAS job with PandaID=6840182584 [2025-10-13 00:54:47] Running command: /cvmfs/atlas.cern.ch/repo/containers/sw/apptainer/x86_64-el7/current/bin/apptainer exec -B /cvmfs,/tmp/job_10534167/atlas/pilot/slots/0 /cvmfs/atlas.cern.ch/repo/containers/fs/singularity/x86_64-centos7 sh start_atlas.sh [2025-10-13 01:42:15] *** The last 200 lines of the pilot log: *** [2025-10-13 01:42:15] status=None [2025-10-13 01:42:15] status_code=0 [2025-10-13 01:42:15] storage_token= [2025-10-13 01:42:15] surl=/tmp/job_10534167/atlas/pilot/slots/0/PanDA_Pilot-6840182584/log.46676269._081399.job.log.tgz.1 [2025-10-13 01:42:15] turl=davs://dav.ndgf.org:443/atlas/disk/atlasdatadisk/rucio/mc23_13p6TeV/8a/23/log.46676269._081399.job.log.tgz.1 [2025-10-13 01:42:15] workdir=None [2025-10-13 01:42:15] ] [2025-10-13 01:42:15] 2025-10-12 23:41:34,685 | INFO | transferring file log.46676269._081399.job.log.tgz.1 from /tmp/job_10534167/atlas/pilot/slots/0/PanDA_Pilot-6840182584/log.46676269._081399.job.log.tgz.1 to /tmp/j [2025-10-13 01:42:15] 2025-10-12 23:41:34,685 | INFO | executing command: /usr/bin/env mv /tmp/job_10534167/atlas/pilot/slots/0/PanDA_Pilot-6840182584/log.46676269._081399.job.log.tgz.1 /tmp/job_10534167/atlas/pilot/sl [2025-10-13 01:42:15] 2025-10-12 23:41:34,693 | INFO | adding to output.list: log.46676269._081399.job.log.tgz.1 davs://dav.ndgf.org:443/atlas/disk/atlasdatadisk/rucio/mc23_13p6TeV/8a/23/log.46676269._081399.job.log.tg [2025-10-13 01:42:15] 2025-10-12 23:41:34,694 | INFO | alt stage-out settings: ['pl', 'write_lan', 'w', 'default'], allow_altstageout=False, remain_files=0, has_altstorage=True [2025-10-13 01:42:15] 2025-10-12 23:41:34,694 | INFO | summary of transferred files: [2025-10-13 01:42:15] 2025-10-12 23:41:34,694 | INFO | -- lfn=log.46676269._081399.job.log.tgz.1, status_code=0, status=transferred [2025-10-13 01:42:15] 2025-10-12 23:41:34,694 | INFO | stage-out finished correctly [2025-10-13 01:42:15] 2025-10-12 23:41:36,043 | INFO | time since job start (2804s) is within the limit (172800.0s) [2025-10-13 01:42:15] 2025-10-12 23:41:36,221 | INFO | monitor loop #209: job 0:6840182584 is in state 'finished' [2025-10-13 01:42:15] 2025-10-12 23:41:36,221 | INFO | will abort job monitoring soon since job state=finished (job is still in queue) [2025-10-13 01:42:15] 2025-10-12 23:41:37,843 | INFO | finished stage-out for finished payload, adding job to finished_jobs queue [2025-10-13 01:42:15] 2025-10-12 23:41:38,048 | INFO | time since job start (2806s) is within the limit (172800.0s) [2025-10-13 01:42:15] 2025-10-12 23:41:38,724 | INFO | monitor loop #210: job 0:6840182584 is in state 'finished' [2025-10-13 01:42:15] 2025-10-12 23:41:38,724 | INFO | will abort job monitoring soon since job state=finished (job is still in queue) [2025-10-13 01:42:15] 2025-10-12 23:41:40,053 | INFO | time since job start (2808s) is within the limit (172800.0s) [2025-10-13 01:42:15] 2025-10-12 23:41:40,880 | INFO | job 6840182584 has state=finished [2025-10-13 01:42:15] 2025-10-12 23:41:40,880 | INFO | preparing for final server update for job 6840182584 in state='finished' [2025-10-13 01:42:15] 2025-10-12 23:41:40,880 | INFO | this job has now completed (state=finished) [2025-10-13 01:42:15] 2025-10-12 23:41:40,880 | INFO | pilot will not update the server (heartbeat message will be written to file) [2025-10-13 01:42:15] 2025-10-12 23:41:40,880 | INFO | log transfer has been attempted: DONE [2025-10-13 01:42:15] 2025-10-12 23:41:40,881 | INFO | job 6840182584 has finished - writing final server update [2025-10-13 01:42:15] 2025-10-12 23:41:40,881 | INFO | total number of processed events: 400 (read) [2025-10-13 01:42:15] 2025-10-12 23:41:40,882 | INFO | executing command: lscpu [2025-10-13 01:42:15] 2025-10-12 23:41:40,912 | INFO | executing command: export ATLAS_LOCAL_ROOT_BASE=/cvmfs/atlas.cern.ch/repo/ATLASLocalRootBase;source ${ATLAS_LOCAL_ROOT_BASE}/user/atlasLocalSetup.sh --quiet;lsetup [2025-10-13 01:42:15] 2025-10-12 23:41:41,184 | INFO | PID=14551 has CPU usage=4.7% 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 01:42:15] 2025-10-12 23:41:41,184 | INFO | .. there are 3 such processes running [2025-10-13 01:42:15] 2025-10-12 23:41:41,226 | INFO | monitor loop #211: job 0:6840182584 is in state 'finished' [2025-10-13 01:42:15] 2025-10-12 23:41:41,226 | INFO | will abort job monitoring soon since job state=finished (job is still in queue) [2025-10-13 01:42:15] 2025-10-12 23:41:42,184 | INFO | time since job start (2810s) is within the limit (172800.0s) [2025-10-13 01:42:15] 2025-10-12 23:41:42,566 | INFO | CPU arch script returned: x86-64-v3 [2025-10-13 01:42:15] 2025-10-12 23:41:42,570 | INFO | found 64 cores (32 cores per socket, 2 sockets) , CPU MHz: 2620.5364062500003 [2025-10-13 01:42:15] 2025-10-12 23:41:42,575 | INFO | using path: /tmp/job_10534167/atlas/pilot/slots/0/PanDA_Pilot-6840182584/memory_monitor_summary.json (trf name=prmon) [2025-10-13 01:42:15] 2025-10-12 23:41:42,576 | INFO | extracted standard info from prmon json [2025-10-13 01:42:15] 2025-10-12 23:41:42,576 | INFO | extracted standard memory fields from prmon json [2025-10-13 01:42:15] 2025-10-12 23:41:42,576 | WARNING | GPU info not found in prmon json: 'gpu' [2025-10-13 01:42:15] 2025-10-12 23:41:42,576 | WARNING | format EVNTtoHITS has no such key: dbData [2025-10-13 01:42:15] 2025-10-12 23:41:42,576 | WARNING | format EVNTtoHITS has no such key: dbTime [2025-10-13 01:42:15] 2025-10-12 23:41:42,577 | INFO | fitting pss+swap vs Time [2025-10-13 01:42:15] 2025-10-12 23:41:42,577 | INFO | sum of square deviations: 18381740.0 [2025-10-13 01:42:15] 2025-10-12 23:41:42,577 | INFO | sum of deviations: -1654064654.0000002 [2025-10-13 01:42:15] 2025-10-12 23:41:42,577 | INFO | mean x: 1760311173.0 [2025-10-13 01:42:15] 2025-10-12 23:41:42,577 | INFO | mean y: 2596099.923076923 [2025-10-13 01:42:15] 2025-10-12 23:41:42,577 | INFO | -- intersect: 158402643717.86237 [2025-10-13 01:42:15] 2025-10-12 23:41:42,577 | INFO | intersect: 158402643717.86237 [2025-10-13 01:42:15] 2025-10-12 23:41:42,577 | INFO | chi2: 0.008742559918480705 [2025-10-13 01:42:15] 2025-10-12 23:41:42,577 | INFO | -- intersect: 158402643717.86237 [2025-10-13 01:42:15] 2025-10-12 23:41:42,577 | INFO | current memory leak: -89.98 B/s (using 39 data points, chi2=0.01) [2025-10-13 01:42:15] 2025-10-12 23:41:42,577 | INFO | could have reported an average CPU frequency of 2718 MHz (5 samples) [2025-10-13 01:42:15] 2025-10-12 23:41:42,577 | INFO | .............................. [2025-10-13 01:42:15] 2025-10-12 23:41:42,577 | INFO | . Timing measurements: [2025-10-13 01:42:15] 2025-10-12 23:41:42,577 | INFO | . get job = 0 s [2025-10-13 01:42:15] 2025-10-12 23:41:42,577 | INFO | . initial setup = 1 s [2025-10-13 01:42:15] 2025-10-12 23:41:42,577 | INFO | . payload setup = 2 s [2025-10-13 01:42:15] 2025-10-12 23:41:42,577 | INFO | . stage-in = 0 s [2025-10-13 01:42:15] 2025-10-12 23:41:42,578 | INFO | . payload execution = 2784 s [2025-10-13 01:42:15] 2025-10-12 23:41:42,578 | INFO | . stage-out = 0 s [2025-10-13 01:42:15] 2025-10-12 23:41:42,578 | INFO | . log creation = 0 s [2025-10-13 01:42:15] 2025-10-12 23:41:42,578 | INFO | .............................. [2025-10-13 01:42:15] 2025-10-12 23:41:42,627 | INFO | [2025-10-13 01:42:15] 2025-10-12 23:41:42,627 | INFO | job summary report [2025-10-13 01:42:15] 2025-10-12 23:41:42,627 | INFO | -------------------------------------------------- [2025-10-13 01:42:15] 2025-10-12 23:41:42,627 | INFO | PanDA job id: 6840182584 [2025-10-13 01:42:15] 2025-10-12 23:41:42,627 | INFO | task id: 46676269 [2025-10-13 01:42:15] 2025-10-12 23:41:42,627 | INFO | errors: (none) [2025-10-13 01:42:15] 2025-10-12 23:41:42,627 | INFO | status: LOG_TRANSFER = DONE [2025-10-13 01:42:15] 2025-10-12 23:41:42,628 | INFO | pilot state: finished [2025-10-13 01:42:15] 2025-10-12 23:41:42,628 | INFO | transexitcode: 0 [2025-10-13 01:42:15] 2025-10-12 23:41:42,628 | INFO | exeerrorcode: 0 [2025-10-13 01:42:15] 2025-10-12 23:41:42,628 | INFO | exeerrordiag: [2025-10-13 01:42:15] 2025-10-12 23:41:42,628 | INFO | exitcode: 0 [2025-10-13 01:42:15] 2025-10-12 23:41:42,628 | INFO | exitmsg: OK [2025-10-13 01:42:15] 2025-10-12 23:41:42,628 | INFO | cpuconsumptiontime: 20004 s [2025-10-13 01:42:15] 2025-10-12 23:41:42,628 | INFO | nevents: 400 [2025-10-13 01:42:15] 2025-10-12 23:41:42,628 | INFO | neventsw: 0 [2025-10-13 01:42:15] 2025-10-12 23:41:42,628 | INFO | pid: 22679 [2025-10-13 01:42:15] 2025-10-12 23:41:42,628 | INFO | pgrp: 22679 [2025-10-13 01:42:15] 2025-10-12 23:41:42,628 | INFO | corecount: 8 [2025-10-13 01:42:15] 2025-10-12 23:41:42,628 | INFO | event service: False [2025-10-13 01:42:15] 2025-10-12 23:41:42,628 | INFO | sizes: {0: 2348650, 1: 2348960, 2: 2349222, 11: 2349250, 2789: 2374688, 2790: 2383899, 2793: 2383899, 2798: 2384125} [2025-10-13 01:42:15] 2025-10-12 23:41:42,628 | INFO | -------------------------------------------------- [2025-10-13 01:42:15] 2025-10-12 23:41:42,628 | INFO | [2025-10-13 01:42:15] 2025-10-12 23:41:42,628 | INFO | executing command: ls -lF /tmp/job_10534167/atlas/pilot/slots/0 [2025-10-13 01:42:15] 2025-10-12 23:41:42,637 | INFO | queue jobs had 0 job(s) [purged] [2025-10-13 01:42:15] 2025-10-12 23:41:42,637 | INFO | queue payloads had 0 job(s) [purged] [2025-10-13 01:42:15] 2025-10-12 23:41:42,637 | INFO | queue data_in had 0 job(s) [purged] [2025-10-13 01:42:15] 2025-10-12 23:41:42,637 | INFO | queue data_out had 0 job(s) [purged] [2025-10-13 01:42:15] 2025-10-12 23:41:42,637 | INFO | queue current_data_in had 0 job(s) [purged] [2025-10-13 01:42:15] 2025-10-12 23:41:42,637 | INFO | queue validated_jobs had 0 job(s) [purged] [2025-10-13 01:42:15] 2025-10-12 23:41:42,637 | INFO | queue validated_payloads had 0 job(s) [purged] [2025-10-13 01:42:15] 2025-10-12 23:41:42,637 | INFO | queue monitored_payloads had 0 job(s) [purged] [2025-10-13 01:42:15] 2025-10-12 23:41:42,637 | INFO | queue finished_jobs had 0 job(s) [purged] [2025-10-13 01:42:15] 2025-10-12 23:41:42,637 | INFO | queue finished_payloads had 0 job(s) [purged] [2025-10-13 01:42:15] 2025-10-12 23:41:42,637 | INFO | queue finished_data_in had 1 job(s) [purged] [2025-10-13 01:42:15] 2025-10-12 23:41:42,637 | INFO | queue finished_data_out had 0 job(s) [purged] [2025-10-13 01:42:15] 2025-10-12 23:41:42,637 | INFO | queue failed_jobs had 0 job(s) [purged] [2025-10-13 01:42:15] 2025-10-12 23:41:42,638 | INFO | queue failed_payloads had 0 job(s) [purged] [2025-10-13 01:42:15] 2025-10-12 23:41:42,638 | INFO | queue failed_data_in had 0 job(s) [purged] [2025-10-13 01:42:15] 2025-10-12 23:41:42,638 | INFO | queue failed_data_out had 0 job(s) [purged] [2025-10-13 01:42:15] 2025-10-12 23:41:42,638 | INFO | queue completed_jobs had 0 job(s) [purged] [2025-10-13 01:42:15] 2025-10-12 23:41:42,638 | INFO | queue completed_jobids has 1 job(s) [2025-10-13 01:42:15] 2025-10-12 23:41:42,638 | INFO | queue realtimelog_payloads had 0 job(s) [purged] [2025-10-13 01:42:15] 2025-10-12 23:41:42,638 | INFO | queue messages had 0 job(s) [purged] [2025-10-13 01:42:15] 2025-10-12 23:41:42,638 | INFO | job 6840182584 has completed (purged errors) [2025-10-13 01:42:15] 2025-10-12 23:41:42,638 | INFO | overall cleanup function is called [2025-10-13 01:42:15] 2025-10-12 23:41:43,644 | INFO | --- collectZombieJob: --- 10, [22679] [2025-10-13 01:42:15] 2025-10-12 23:41:43,644 | INFO | zombie collector waiting for pid 22679 [2025-10-13 01:42:15] 2025-10-12 23:41:43,644 | INFO | harmless exception when collecting zombies: [Errno 10] No child processes [2025-10-13 01:42:15] 2025-10-12 23:41:43,644 | INFO | collected zombie processes [2025-10-13 01:42:15] 2025-10-12 23:41:43,644 | INFO | will attempt to kill all subprocesses of pid=22679 [2025-10-13 01:42:15] 2025-10-12 23:41:43,740 | INFO | process IDs to be killed: [22679] (in reverse order) [2025-10-13 01:42:15] 2025-10-12 23:41:43,772 | WARNING | found no corresponding commands to process id(s) [2025-10-13 01:42:15] 2025-10-12 23:41:43,772 | INFO | Do not look for orphan processes in BOINC jobs [2025-10-13 01:42:15] 2025-10-12 23:41:43,776 | INFO | did not find any defunct processes belonging to 22679 [2025-10-13 01:42:15] 2025-10-12 23:41:43,779 | INFO | did not find any defunct processes belonging to 22679 [2025-10-13 01:42:15] 2025-10-12 23:41:43,779 | INFO | ready for new job [2025-10-13 01:42:15] 2025-10-12 23:41:43,779 | INFO | pilot has finished with previous job - re-establishing logging [2025-10-13 01:42:15] 2025-10-12 23:41:43,779 | INFO | *************************************** [2025-10-13 01:42:15] 2025-10-12 23:41:43,779 | INFO | *** PanDA Pilot version 3.11.0.29 *** [2025-10-13 01:42:15] 2025-10-12 23:41:43,779 | INFO | *************************************** [2025-10-13 01:42:15] 2025-10-12 23:41:43,779 | INFO | [2025-10-13 01:42:15] 2025-10-12 23:41:43,794 | INFO | architecture information: [2025-10-13 01:42:15] 2025-10-12 23:41:43,794 | INFO | executing command: cat /etc/os-release [2025-10-13 01:42:15] 2025-10-12 23:41:43,800 | INFO | cat /etc/os-release: [2025-10-13 01:42:15] NAME="CentOS Linux" [2025-10-13 01:42:15] VERSION="7 (Core)" [2025-10-13 01:42:15] ID="centos" [2025-10-13 01:42:15] ID_LIKE="rhel fedora" [2025-10-13 01:42:15] VERSION_ID="7" [2025-10-13 01:42:15] PRETTY_NAME="CentOS Linux 7 (Core)" [2025-10-13 01:42:15] ANSI_COLOR="0;31" [2025-10-13 01:42:15] CPE_NAME="cpe:/o:centos:centos:7" [2025-10-13 01:42:15] HOME_URL="https://www.centos.org/" [2025-10-13 01:42:15] BUG_REPORT_URL="https://bugs.centos.org/" [2025-10-13 01:42:15] [2025-10-13 01:42:15] CENTOS_MANTISBT_PROJECT="CentOS-7" [2025-10-13 01:42:15] CENTOS_MANTISBT_PROJECT_VERSION="7" [2025-10-13 01:42:15] REDHAT_SUPPORT_PRODUCT="centos" [2025-10-13 01:42:15] REDHAT_SUPPORT_PRODUCT_VERSION="7" [2025-10-13 01:42:15] [2025-10-13 01:42:15] 2025-10-12 23:41:43,800 | INFO | *************************************** [2025-10-13 01:42:15] 2025-10-12 23:41:44,303 | INFO | executing command: df -mP /tmp/job_10534167/atlas/pilot/slots/0 [2025-10-13 01:42:15] 2025-10-12 23:41:44,309 | INFO | sufficient remaining disk space (227637460992 B) [2025-10-13 01:42:15] 2025-10-12 23:41:44,309 | WARNING | since timefloor is set to 0, pilot was only allowed to run one job [2025-10-13 01:42:15] 2025-10-12 23:41:44,309 | INFO | current server update state: UPDATING_FINAL [2025-10-13 01:42:15] 2025-10-12 23:41:44,309 | INFO | update_server=False [2025-10-13 01:42:15] 2025-10-12 23:41:44,309 | WARNING | setting graceful_stop since proceed_with_getjob() returned False (pilot will end) [2025-10-13 01:42:15] 2025-10-12 23:41:44,309 | WARNING | data:queue_monitoring:received graceful stop - abort after this iteration [2025-10-13 01:42:15] 2025-10-12 23:41:44,309 | WARNING | job:queue_monitor:received graceful stop - abort after this iteration [2025-10-13 01:42:15] 2025-10-12 23:41:44,734 | WARNING | job:job_monitor:received graceful stop - abort after this iteration [2025-10-13 01:42:15] 2025-10-12 23:41:44,734 | INFO | aborting loop [2025-10-13 01:42:15] 2025-10-12 23:41:44,779 | INFO | all job control threads have been joined [2025-10-13 01:42:15] 2025-10-12 23:41:45,002 | INFO | all data control threads have been joined [2025-10-13 01:42:15] 2025-10-12 23:41:45,005 | INFO | all payload control threads have been joined [2025-10-13 01:42:15] 2025-10-12 23:41:45,258 | WARNING | data:copytool_out:received graceful stop - abort after this iteration [2025-10-13 01:42:15] 2025-10-12 23:41:45,314 | INFO | [job] retrieve thread has finished [2025-10-13 01:42:15] 2025-10-12 23:41:45,315 | INFO | [job] queue monitor thread has finished [2025-10-13 01:42:15] 2025-10-12 23:41:45,353 | INFO | [payload] failed_post thread has finished [2025-10-13 01:42:15] 2025-10-12 23:41:45,740 | INFO | [job] job monitor thread has finished [2025-10-13 01:42:15] 2025-10-12 23:41:45,784 | INFO | [job] control thread has finished [2025-10-13 01:42:15] 2025-10-12 23:41:45,793 | INFO | [payload] execute_payloads thread has finished [2025-10-13 01:42:15] 2025-10-12 23:41:45,815 | INFO | [payload] run_realtimelog thread has finished [2025-10-13 01:42:15] 2025-10-12 23:41:46,007 | INFO | [data] control thread has finished [2025-10-13 01:42:15] 2025-10-12 23:41:46,010 | INFO | [payload] control thread has finished [2025-10-13 01:42:15] 2025-10-12 23:41:46,242 | INFO | [job] validate thread has finished [2025-10-13 01:42:15] 2025-10-12 23:41:46,288 | INFO | [job] create_data_payload thread has finished [2025-10-13 01:42:15] 2025-10-12 23:41:46,332 | INFO | [payload] validate_pre thread has finished [2025-10-13 01:42:15] 2025-10-12 23:41:46,544 | INFO | [payload] validate_post thread has finished [2025-10-13 01:42:15] 2025-10-12 23:41:46,651 | INFO | [data] copytool_in thread has finished [2025-10-13 01:42:15] 2025-10-12 23:41:47,264 | INFO | [data] copytool_out thread has finished [2025-10-13 01:42:15] 2025-10-12 23:41:48,315 | INFO | [data] queue_monitor thread has finished [2025-10-13 01:42:15] 2025-10-12 23:41:56,166 | INFO | [monitor] cgroup control has ended [2025-10-13 01:42:15] 2025-10-12 23:41:56,349 | INFO | only monitor.control thread still running - safe to abort: ['<_MainThread(MainThread, started 23456247945024)>', '<ExcThread(monitor, started 23456066770688)>'] [2025-10-13 01:42:15] 2025-10-12 23:42:01,374 | INFO | all workflow threads have been joined [2025-10-13 01:42:15] 2025-10-12 23:42:01,374 | INFO | end of generic workflow (traces error code: 0) [2025-10-13 01:42:15] 2025-10-12 23:42:01,374 | INFO | traces error code: 0 [2025-10-13 01:42:15] 2025-10-12 23:42:01,375 | INFO | pilot has finished (exit code=0, shell exit code=0) [2025-10-13 01:42:15] 2025-10-12 23:42:15,372 | INFO | PID=14551 has CPU usage=0.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 01:42:15] 2025-10-12 23:42:15,373 | INFO | .. there are 3 such processes running [2025-10-13 01:42:15] 2025-10-12 23:42:15,373 | INFO | found 0 job(s) in 20 queues [2025-10-13 01:42:15] 2025-10-12 23:42:15,373 | WARNING | pilot monitor received instruction that args.graceful_stop has been set [2025-10-13 01:42:15] 2025-10-12 23:42:15,373 | WARNING | will wait for a maximum of 300 s for threads to finish [2025-10-13 01:42:15] 2025-10-12 23:42:15,373 | WARNING | job_aborted has been set - aborting pilot monitoring [2025-10-13 01:42:15] 2025-10-12 23:42:15,373 | INFO | [monitor] control thread has ended [2025-10-13 01:42:15] 2025-10-12 23:42:15,422 [wrapper] ==== pilot stdout END ==== [2025-10-13 01:42:15] 2025-10-12 23:42:15,423 [wrapper] ==== wrapper stdout RESUME ==== [2025-10-13 01:42:15] 2025-10-12 23:42:15,424 [wrapper] pilotpid: 14551 [2025-10-13 01:42:15] 2025-10-12 23:42:15,425 [wrapper] Pilot exit status: 0 [2025-10-13 01:42:15] 2025-10-12 23:42:15,429 [wrapper] pandaids: 6840182584 [2025-10-13 01:42:15] 2025-10-12 23:42:15,450 [wrapper] cleanup supervisor_pilot 30770 14552 [2025-10-13 01:42:15] 2025-10-12 23:42:15,451 [wrapper] Test setup, not cleaning [2025-10-13 01:42:15] 2025-10-12 23:42:15,452 [wrapper] apfmon messages muted [2025-10-13 01:42:15] 2025-10-12 23:42:15,453 [wrapper] ==== wrapper stdout END ==== [2025-10-13 01:42:15] 2025-10-12 23:42:15,454 [wrapper] ==== wrapper stderr END ==== [2025-10-13 01:42:15] *** Error codes and diagnostics *** [2025-10-13 01:42:15] "exeErrorCode": 0, [2025-10-13 01:42:15] "exeErrorDiag": "", [2025-10-13 01:42:15] "pilotErrorCode": 0, [2025-10-13 01:42:15] "pilotErrorDiag": "", [2025-10-13 01:42:15] *** Listing of results directory *** [2025-10-13 01:42:15] total 419508 [2025-10-13 01:42:15] -rw------- 1 mf493845 unix-user 557409 Oct 12 16:30 pilot3.tar.gz [2025-10-13 01:42:15] -rwx------ 1 mf493845 unix-user 36292 Oct 12 16:51 runpilot2-wrapper.sh [2025-10-13 01:42:15] -rw------- 1 mf493845 unix-user 5112 Oct 12 16:51 queuedata.json [2025-10-13 01:42:15] -rw------- 1 mf493845 unix-user 100 Oct 12 23:57 wrapper_26015_x86_64-pc-linux-gnu [2025-10-13 01:42:15] -rwxr-xr-x 1 mf493845 unix-user 7986 Oct 12 23:57 run_atlas [2025-10-13 01:42:15] -rw------- 1 mf493845 unix-user 105 Oct 12 23:57 job.xml [2025-10-13 01:42:15] -rw-r--r-- 2 mf493845 unix-user 223198924 Oct 13 00:54 EVNT.46676267._004541.pool.root.1 [2025-10-13 01:42:15] -rw-r--r-- 2 mf493845 unix-user 15120 Oct 13 00:54 start_atlas.sh [2025-10-13 01:42:15] drwxrwx--x 2 mf493845 unix-user 100 Oct 13 00:54 shared [2025-10-13 01:42:15] -rw-r--r-- 2 mf493845 unix-user 569677 Oct 13 00:54 input.tar.gz [2025-10-13 01:42:15] -rw------- 1 mf493845 unix-user 6393 Oct 13 00:54 init_data.xml [2025-10-13 01:42:15] -rw------- 1 mf493845 unix-user 0 Oct 13 00:54 boinc_setup_complete [2025-10-13 01:42:15] -rw------- 1 mf493845 unix-user 8192 Oct 13 00:54 boinc_mmap_file [2025-10-13 01:42:15] -rw------- 1 mf493845 unix-user 0 Oct 13 00:54 boinc_lockfile [2025-10-13 01:42:15] -rw------- 1 mf493845 unix-user 2549 Oct 13 00:54 pandaJob.out [2025-10-13 01:42:15] -rw------- 1 mf493845 unix-user 975603 Oct 13 00:54 agis_schedconf.cvmfs.json [2025-10-13 01:42:15] -rw------- 1 mf493845 unix-user 1560580 Oct 13 00:54 agis_ddmendpoints.agis.ALL.json [2025-10-13 01:42:15] drwx------ 5 mf493845 unix-user 440 Oct 13 00:54 pilot3 [2025-10-13 01:42:15] -rw------- 1 mf493845 unix-user 201026509 Oct 13 01:41 HITS.46676269._081399.pool.root.1 [2025-10-13 01:42:15] -rw------- 1 mf493845 unix-user 95 Oct 13 01:41 pilot_heartbeat.json [2025-10-13 01:42:15] -rw------- 1 mf493845 unix-user 1010 Oct 13 01:41 memory_monitor_summary.json [2025-10-13 01:42:15] -rw------- 1 mf493845 unix-user 293879 Oct 13 01:41 log.46676269._081399.job.log.tgz.1 [2025-10-13 01:42:15] -rw------- 1 mf493845 unix-user 7770 Oct 13 01:41 heartbeat.json [2025-10-13 01:42:15] -rw------- 1 mf493845 unix-user 820 Oct 13 01:42 pilotlog.txt [2025-10-13 01:42:15] -rw------- 1 mf493845 unix-user 447639 Oct 13 01:42 log.46676269._081399.job.log.1 [2025-10-13 01:42:15] -rw------- 1 mf493845 unix-user 357 Oct 13 01:42 output.list [2025-10-13 01:42:15] -rw------- 1 mf493845 unix-user 620 Oct 13 01:42 runtime_log [2025-10-13 01:42:15] -rw------- 1 mf493845 unix-user 757760 Oct 13 01:42 result.tar.gz [2025-10-13 01:42:15] -rw------- 1 mf493845 unix-user 642 Oct 13 01:42 VZzLDmZbCS8n9Rq4apOajLDm4fhM0noT9bVof3QYDmPAUMDmNZgetm.diag [2025-10-13 01:42:15] -rw------- 1 mf493845 unix-user 9076 Oct 13 01:42 runtime_log.err [2025-10-13 01:42:15] -rw------- 1 mf493845 unix-user 22576 Oct 13 01:42 stderr.txt [2025-10-13 01:42:15] HITS file was successfully produced: [2025-10-13 01:42:15] -rw------- 1 mf493845 unix-user 201026509 Oct 13 01:41 shared/HITS.pool.root.1 [2025-10-13 01:42:15] *** Contents of shared directory: *** [2025-10-13 01:42:15] total 415600 [2025-10-13 01:42:15] -rw-r--r-- 2 mf493845 unix-user 223198924 Oct 13 00:54 ATLAS.root_0 [2025-10-13 01:42:15] -rw-r--r-- 2 mf493845 unix-user 15120 Oct 13 00:54 start_atlas.sh [2025-10-13 01:42:15] -rw-r--r-- 2 mf493845 unix-user 569677 Oct 13 00:54 input.tar.gz [2025-10-13 01:42:15] -rw------- 1 mf493845 unix-user 201026509 Oct 13 01:41 HITS.pool.root.1 [2025-10-13 01:42:15] -rw------- 1 mf493845 unix-user 757760 Oct 13 01:42 result.tar.gz 01:42:17 (9711): run_atlas exited; CPU time 20042.310904 01:42:17 (9711): called boinc_finish(0) </stderr_txt> ]]>
©2025 CERN