justIN           Dashboard       Workflows       Jobs       AWT       Sites       Storages       Docs       Login

Jobsub ID 272045.1@dunegpschedd01.fnal.gov

Jobsub ID272045.1@dunegpschedd01.fnal.gov
Workflow ID11549
Stage ID1
User nameykermaid@fnal.gov
RequestedProcessors4
GPUNo
RSS bytes6815744000 (6500 MiB)
Wall seconds limit80000 (22 hours)
Submitted time2026-01-06 14:06:33
SiteUS_UChicago
EntryEngage_US_MWT2_uct2_gk02_condce_mcore
Last heartbeat2026-01-06 14:19:19
From worker nodeHostnamemwt2-c176.campuscluster.illinois.edu
cpuinfoIntel(R) Xeon(R) Gold 6248 CPU @ 2.50GHz
OS releaseScientific Linux release 7.9 (Nitrogen)
Processors4
RSS bytes7864320000 (7500 MiB)
Wall seconds limit86400 (24 hours)
GPU
Inner Apptainer?True
Job statefinished
Started2026-01-06 14:08:32
Input fileshd-protodune-det-reco:np04hd_raw_run028086_0657_dataflow6_datawriter_0_20240721T144857_reco_stage1_reco_stage2_20240812T114822_keepup.root
JobscriptExit code0
Real time10m (631s)
CPU time9m (592s = 93%)
Max RSS bytes1030021120 (982 MiB)
Outputting started2026-01-06 14:19:04
Output fileshttps://fndcadoor.fnal.gov:2880/dune/scratch/users/ykermaid/fnal/11549/1/001/np04hd_raw_run028086_0657_dataflow6_datawriter_0_20240721T144857_reco_stage1_reco_stage2_20240812T114822_keepup_20260106T140851Z_singlehit.root
Finished2026-01-06 14:19:19
Saved logsjustin-logs:272045.1-dunegpschedd01.fnal.gov.logs.tgz
List job events     Cached HTCondor job logs

Jobscript log (last 10,000 characters)

.10-2.17 -z /cvmfs/larsoft.opensciencegrid.org/products -q e26:prof
OPENBLAS_INC=/cvmfs/larsoft.opensciencegrid.org/products/openblas/v0_3_23/Linux64bit+3.10-2.17-e26/include
PYTHON_INCLUDE=/cvmfs/larsoft.opensciencegrid.org/products/python/v3_9_15/Linux64bit+3.10-2.17/include/python3.9
_=/usr/bin/env
Will use justin-get-file
pfn: root://fndcadoor.fnal.gov:1094/pnfs/fnal.gov/usr/dune/persistent/staging/hd-protodune-det-reco/9f/fb/np04hd_raw_run028086_0657_dataflow6_datawriter_0_20240721T144857_reco_stage1_reco_stage2_20240812T114822_keepup.root
did: hd-protodune-det-reco:np04hd_raw_run028086_0657_dataflow6_datawriter_0_20240721T144857_reco_stage1_reco_stage2_20240812T114822_keepup.root
output_file: np04hd_raw_run028086_0657_dataflow6_datawriter_0_20240721T144857_reco_stage1_reco_stage2_20240812T114822_keepup_20260106T140851Z_singlehit.root
Running reco stage1
%MSG-i MF_INIT_OK:  Early 06-Jan-2026 08:09:01 CST JobSetup
Messagelogger initialization complete.
%MSG
Info in <TGeoManager::Import>: Reading geometry from file: /cvmfs/dune.opensciencegrid.org/products/dune/dunecore/v10_12_01d00/gdml/protodunehd_v6_refactored.gdml
Info in <TGeoManager::TGeoManager>: Geometry GDMLImport, Geometry imported from GDML created
Info in <TGeoManager::SetTopVolume>: Top volume is volWorld. Master volume is volWorld
Info in <TGeoNavigator::BuildCache>: --- Maximum geometry depth set to 100
Info in <TGeoManager::CheckGeometry>: Fixing runtime shapes...
Info in <TGeoManager::CheckGeometry>: ...Nothing to fix
Info in <TGeoManager::CloseGeometry>: Counting nodes...
Info in <TGeoManager::Voxelize>: Voxelizing...
Info in <TGeoManager::CloseGeometry>: Building cache...
Info in <TGeoManager::CountLevels>: max level = 5, max placements = 1148
Info in <TGeoManager::CloseGeometry>: 25610 nodes/ 5537 volume UID's in Geometry imported from GDML
Info in <TGeoManager::CloseGeometry>: ----------------modeler ready----------------
%MSG-i AuxDetGeometryCore:  Early 06-Jan-2026 08:09:15 CST JobSetup
New detector geometry loaded from
	/cvmfs/dune.opensciencegrid.org/products/dune/dunecore/v10_12_01d00/gdml/protodunehd_v6_refactored.gdml
%MSG
%MSG-i GeometryCore:  Early 06-Jan-2026 08:09:15 CST JobSetup
Sorting volumes...
%MSG
%MSG-i GeometryCore:  Early 06-Jan-2026 08:09:15 CST JobSetup
New detector geometry loaded from
	/cvmfs/dune.opensciencegrid.org/products/dune/dunecore/v10_12_01d00/gdml/protodunehd_v6_refactored.gdml
%MSG
%MSG-i DuneApaWireReadoutGeom:  Early 06-Jan-2026 08:09:15 CST JobSetup
Initializing wire readout...
%MSG
Cryostat 0:
  10240 total channels
  4 APAs
  For all identical APA:
    Number of channels per APA = 2560
    U channels per APA = 800
    V channels per APA = 800
    Z channels per APA = 960
    Pitch in U Plane = 0.4669
    Pitch in V Plane = 0.4669
    Pitch in Z Plane = 0.4792
%MSG-i SimpleChannelStatusService:  Early 06-Jan-2026 08:09:15 CST JobSetup
Loaded from configuration:
  - 0 bad channels
  - 0 noisy channels
  - largest channel ID: 10239, largest present: 10239
%MSG
%MSG-i setupProvider<DetectorPropertiesStandard>:  Early  06-Jan-2026 08:09:15 CST JobSetup
Asked to ignore 1 keys: 'InheritNumberTimeSamples'
%MSG
IFDH constructor, got keys:
service_type, 
IFDH: didn't find a base uri...

06-Jan-2026 08:09:17 CST  Initiating request to open input file "root://fndcadoor.fnal.gov:1094/pnfs/fnal.gov/usr/dune/persistent/staging/hd-protodune-det-reco/9f/fb/np04hd_raw_run028086_0657_dataflow6_datawriter_0_20240721T144857_reco_stage1_reco_stage2_20240812T114822_keepup.root"
06-Jan-2026 08:09:23 CST  Opened input file "root://fndcadoor.fnal.gov:1094/pnfs/fnal.gov/usr/dune/persistent/staging/hd-protodune-det-reco/9f/fb/np04hd_raw_run028086_0657_dataflow6_datawriter_0_20240721T144857_reco_stage1_reco_stage2_20240812T114822_keepup.root"
Begin processing the 1st record. run: 28086 subRun: 1 event: 163022 at 06-Jan-2026 08:09:26 CST
Begin processing the 2nd record. run: 28086 subRun: 1 event: 163030 at 06-Jan-2026 08:09:31 CST
Begin processing the 3rd record. run: 28086 subRun: 1 event: 163038 at 06-Jan-2026 08:09:35 CST
Begin processing the 4th record. run: 28086 subRun: 1 event: 163046 at 06-Jan-2026 08:09:47 CST
Begin processing the 5th record. run: 28086 subRun: 1 event: 163054 at 06-Jan-2026 08:09:51 CST
Begin processing the 6th record. run: 28086 subRun: 1 event: 163062 at 06-Jan-2026 08:10:03 CST
Begin processing the 7th record. run: 28086 subRun: 1 event: 163070 at 06-Jan-2026 08:10:14 CST
Begin processing the 8th record. run: 28086 subRun: 1 event: 163078 at 06-Jan-2026 08:10:23 CST
Begin processing the 9th record. run: 28086 subRun: 1 event: 163086 at 06-Jan-2026 08:11:16 CST
Begin processing the 10th record. run: 28086 subRun: 1 event: 163094 at 06-Jan-2026 08:11:27 CST
Begin processing the 11th record. run: 28086 subRun: 1 event: 163102 at 06-Jan-2026 08:11:39 CST
Begin processing the 12th record. run: 28086 subRun: 1 event: 163118 at 06-Jan-2026 08:11:47 CST
Begin processing the 13th record. run: 28086 subRun: 1 event: 163126 at 06-Jan-2026 08:11:51 CST
Begin processing the 14th record. run: 28086 subRun: 1 event: 163134 at 06-Jan-2026 08:12:02 CST
Begin processing the 15th record. run: 28086 subRun: 1 event: 163142 at 06-Jan-2026 08:13:21 CST
Begin processing the 16th record. run: 28086 subRun: 1 event: 163150 at 06-Jan-2026 08:13:29 CST
Begin processing the 17th record. run: 28086 subRun: 1 event: 163158 at 06-Jan-2026 08:13:55 CST
Begin processing the 18th record. run: 28086 subRun: 1 event: 163166 at 06-Jan-2026 08:14:07 CST
Begin processing the 19th record. run: 28086 subRun: 1 event: 163174 at 06-Jan-2026 08:14:18 CST
Begin processing the 20th record. run: 28086 subRun: 1 event: 163182 at 06-Jan-2026 08:14:29 CST
Begin processing the 21st record. run: 28086 subRun: 1 event: 163190 at 06-Jan-2026 08:14:48 CST
Begin processing the 22nd record. run: 28086 subRun: 1 event: 163198 at 06-Jan-2026 08:15:10 CST
Begin processing the 23rd record. run: 28086 subRun: 1 event: 163206 at 06-Jan-2026 08:15:51 CST
Begin processing the 24th record. run: 28086 subRun: 1 event: 163214 at 06-Jan-2026 08:16:09 CST
Begin processing the 25th record. run: 28086 subRun: 1 event: 163222 at 06-Jan-2026 08:16:23 CST
Begin processing the 26th record. run: 28086 subRun: 1 event: 163230 at 06-Jan-2026 08:16:29 CST
Begin processing the 27th record. run: 28086 subRun: 1 event: 163238 at 06-Jan-2026 08:16:54 CST
Begin processing the 28th record. run: 28086 subRun: 1 event: 163246 at 06-Jan-2026 08:17:13 CST
Begin processing the 29th record. run: 28086 subRun: 1 event: 163254 at 06-Jan-2026 08:17:33 CST
Begin processing the 30th record. run: 28086 subRun: 1 event: 163278 at 06-Jan-2026 08:17:48 CST
Begin processing the 31st record. run: 28086 subRun: 1 event: 163286 at 06-Jan-2026 08:18:27 CST
06-Jan-2026 08:18:58 CST  Closed input file "root://fndcadoor.fnal.gov:1094/pnfs/fnal.gov/usr/dune/persistent/staging/hd-protodune-det-reco/9f/fb/np04hd_raw_run028086_0657_dataflow6_datawriter_0_20240721T144857_reco_stage1_reco_stage2_20240812T114822_keepup.root"

====================================================================================================================
TimeTracker printout (sec)            Min           Avg           Max         Median          RMS         nEvts   
====================================================================================================================
Full event                          3.64802       18.4344       79.7006       11.9967       15.9813        31     
--------------------------------------------------------------------------------------------------------------------
source:RootInput(read)            0.000353058   0.00430866     0.0277616    0.000469496   0.00784224       31     
end_path:ana:SingleHit              3.64722       18.4298       79.6999       11.9785       15.983         31     
====================================================================================================================

====================================================================================================
MemoryTracker summary (base-10 MB units used)

  Peak virtual memory usage (VmPeak)  : 2393.41 MB
  Peak resident set size usage (VmHWM): 1030.02 MB
  Details saved in: 'mem.db'
====================================================================================================

TrigReport ---------- Event summary -------------
TrigReport Events total = 31 passed = 31 failed = 0

TrigReport ---------- Modules in End-path ----------
TrigReport        Run    Success      Error Name
TrigReport         31         31          0 ana

TimeReport ---------- Time summary [sec] -------
TimeReport CPU = 560.951787 Real = 571.735347

MemReport  ---------- Memory summary [base-10 MB] ------
MemReport  VmPeak = 2393.41 VmHWM = 1030.02

Art has completed and will exit with status 0.
Output files:
\tHists: np04hd_raw_run028086_0657_dataflow6_datawriter_0_20240721T144857_reco_stage1_reco_stage2_20240812T114822_keepup_20260106T140851Z_singlehit.root
formed
{
  "name": "np04hd_raw_run028086_0657_dataflow6_datawriter_0_20240721T144857_reco_stage1_reco_stage2_20240812T114822_keepup_20260106T140851Z_singlehit.root",
  "namespace": "usertests",
  "metadata": {
    "core.file_format": "root",
    "core.application.name": "reco",
    "core.application.family": "dunesw",
    "core.application.version": "v10_12_01d00",
    "core.data_tier": "root-tuple-virtual",
    "dune.config_file": "runSingleHit_PDHD.fcl",
    "dune.campaign": "hd-protodune-sim-reco",
    "core.start_time": 1767709138.0,
    "core.end_time": 1767709138.0,
    "core.data_stream": "physics",
    "core.file_type": "detector",
    "core.run_type": "hd-protodune",
    "core.runs": [
      28086
    ],
    "core.runs_subruns": [
      2808600001
    ]
  },
  "parents": [
    {
      "did": "hd-protodune-det-reco:np04hd_raw_run028086_0657_dataflow6_datawriter_0_20240721T144857_reco_stage1_reco_stage2_20240812T114822_keepup.root"
    }
  ]
}
justIN time: 2026-02-06 17:08:43 UTC       justIN version: 01.06.00