justIN           Dashboard       Workflows       Jobs       AWT       Sites       Storages       Docs       Login

Jobsub ID 264899.30@justin-prod-sched01.dune.hep.ac.uk

Jobsub ID264899.30@justin-prod-sched01.dune.hep.ac.uk
Workflow ID3493
Stage ID1
User namecalcuttj@fnal.gov
HTCondor Groupgroup_dune.prod_mcsim
RequestedProcessors1
RSS bytes4193255424 (3999 MiB)
Wall seconds limit18000 (5 hours)
Submitted time2024-09-27 09:48:33
SiteUS_FNAL-T1
EntryCMSHTPC_T1_US_FNAL_condce_opp1_whole
Last heartbeat2024-09-27 13:41:00
From worker nodeHostnamedunegli-35088-0-cmswn2324.fnal.gov
cpuinfoIntel(R) Xeon(R) CPU E5-2670 v3 @ 2.30GHz
OS releaseScientific Linux release 7.9 (Nitrogen)
Processors1
RSS bytes4193255424 (3999 MiB)
Wall seconds limit171000 (47 hours)
Inner Apptainer?True
Job statefinished
Allocator namejustin-allocator-pro.dune.hep.ac.uk
Started2024-09-27 10:08:48
Input fileshd-protodune:np04hd_raw_run027310_0530_dataflow1_datawriter_0_20240620T030150.hdf5
JobscriptExit code0
Real time3h (12622s)
CPU time2h (7314s = 57%)
Outputting started2024-09-27 13:39:11
Output fileshd-protodune-det-reco:np04hd_raw_run027310_0530_dataflow1_datawriter_0_20240620T030150_reco_stage1_reco_stage2_20240927T133857_keepup.root
hd-protodune-det-reco:np04hd_raw_run027310_0530_dataflow1_datawriter_0_20240620T030150_reco_stage1_reco_stage2_20240927T133857_keepup_hists.root
Finished2024-09-27 13:41:00
Saved logsjustin-logs:264899.30-justin-prod-sched01.dune.hep.ac.uk.logs.tgz
List job events     Wrapper job log

Jobscript log (last 10,000 characters)

TPC 7
0 X, 0 U, 0 V bad channels
Finding XUV coincidences...
C:0 T:1 56558 XUs and 25551 XVs -> 3586 XUVs
C:0 T:2 14364 XUs and 15996 XVs -> 361 XUVs
C:0 T:3 245 XUs and 421 XVs -> 13 XUVs
C:0 T:4 136 XUs and 146 XVs -> 3 XUVs
C:0 T:5 24135 XUs and 22987 XVs -> 1422 XUVs
C:0 T:6 8104 XUs and 6905 XVs -> 283 XUVs
C:0 T:7 110 XUs and 150 XVs -> 9 XUVs
5677 XUVs total
1401 collection wire objects
5677 potential space points
Neighbour search...
366041 tests to find 141210 neighbours
Iterating with no regularization...
Begin: 5.93645e+07
0 5.70733e+07
1 5.67895e+07
2 5.67718e+07
Now with regularization...
Begin: 5.51996e+07
0 5.51952e+07
BdtBeamParticleIdTool::SliceFeatures::GetLeadingCaloHits - empty calo hit list
BdtBeamParticleIdTool::SliceFeatures::GetLeadingCaloHits - empty calo hit list
---INTERPRETED-MATCHING-OUTPUT------------------------------------------------------------------
---SUMMARY--------------------------------------------------------------------------------------
------------------------------------------------------------------------------------------------

no of hits closeby  2   event 74381 TrkackID 0 startx, y, z 60.0896 594.349 160.66  wireno, peakt tpcno 218 2376.59 1 dist 136.534min T, max_T550.383 2685.85
no of hits closeby  2   event 74381 TrkackID 0 startx, y, z 60.0896 594.349 160.66  wireno, peakt tpcno 218 2376.59 1 dist 136.534min T, max_T550.383 2685.85
27-Sep-2024 13:38:57 UTC  Closed output file "np04hd_raw_run027310_0530_dataflow1_datawriter_0_20240620T030150_reco_stage1_reco_stage2_20240927T133857_keepup.root"
27-Sep-2024 13:38:57 UTC  Closed input file "np04hd_raw_run027310_0530_dataflow1_datawriter_0_20240620T030150_reco_stage1.root"

========================================================================================================================================
TimeTracker printout (sec)                                Min           Avg           Max         Median          RMS         nEvts   
========================================================================================================================================
Full event                                              89.5199       179.57        323.441        171.2        57.0521        35     
----------------------------------------------------------------------------------------------------------------------------------------
source:RootInput(read)                                0.000635368   0.00474962     0.0656156    0.00255837     0.0106002       35     
produce:fembfilter:PDHDFEMBFilter                      0.906174       1.09348       1.56259       1.05428      0.140016        35     
produce:wclsdatahd:WireCellToolkit                      44.7657       53.9314       67.273        50.2737       8.39545        35     
produce:gaushit:GausHitFinder                          0.638911       1.23258       1.74622       1.26872      0.275114        35     
produce:nhitsfilter:NumberOfHitsFilter                0.00023966    0.000514897   0.000848056   0.000492684   0.000116105      35     
produce:reco3d:SpacePointSolver                        0.348818       2.4033        6.05347       1.87612       1.62374        35     
produce:hitpdune:DisambigFromSpacePoints                 0.352        1.31829       2.45295       1.2295       0.652765        35     
produce:pandora:StandardPandora                         11.508        56.4792       149.718       53.4623       33.9966        35     
produce:pandoraWriter:StandardPandora                   0.13662      0.236931      0.335992      0.241459      0.0567886       35     
produce:pandoraTrack:LArPandoraTrackCreation            1.49013       4.43661       11.1425       3.9505        2.43456        35     
produce:pandoraShower:LArPandoraShowerCreation          1.06725       4.77191       13.7012       3.96249       2.97416        35     
produce:pandoracalo:Calorimetry                        0.720469       1.97183       4.30148       1.68331       1.00062        35     
produce:pandoracalonosce:Calorimetry                   0.692655       1.88505       4.10306       1.65615       0.96291        35     
produce:pandorapid:Chi2ParticleID                     0.00199443    0.00291406    0.00453917    0.00279428    0.000664195      35     
produce:pandoraShowercalo:ShowerCalorimetry            0.929099       4.08433       11.1089       3.3869        2.48874        35     
produce:pandoraShowercalonosce:ShowerCalorimetry       0.911981       3.93957       11.4074       3.25634       2.41388        35     
produce:pandoraGnocchiCalo:GnocchiCalorimetry          0.096208      0.180312       0.27951      0.176538      0.0434437       35     
produce:pandoraGnocchiCalonosce:GnocchiCalorimetry     0.0395896     0.0634257     0.0962084     0.0619011     0.0146049       35     
produce:emtrkmichelid:EmTrackMichelId                   21.2081       38.5414       55.6611       40.4783       9.44413        35     
[art]:TriggerResults:TriggerResultInserter            2.5231e-05    4.44037e-05   0.000107809   4.4388e-05    1.36586e-05      35     
end_path:out1:RootOutput                                9.5e-06     1.33987e-05   3.3033e-05    1.2073e-05    4.17012e-06      35     
end_path:michelremoving:michelremoving                 0.0237505     0.0895505     0.380358      0.052159      0.0816945       35     
end_path:michelremovinggnocchi:michelremoving          0.0222121     0.0850397     0.374254      0.046053      0.0816781       35     
end_path:calibanagnocchi:CalibAnaTree                  0.500184       1.52339       4.03722       1.22273      0.881439        35     
end_path:out1:RootOutput(write)                        0.656262       1.13348       1.63914       1.15926      0.257462        35     
========================================================================================================================================

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

  Peak virtual memory usage (VmPeak)  : 5056.7 MB
  Peak resident set size usage (VmHWM): 2694.5 MB
  Details saved in: 'mem.db'
====================================================================================================
Art has completed and will exit with status 0.
Output files:
\tReco: np04hd_raw_run027310_0530_dataflow1_datawriter_0_20240620T030150_reco_stage1_reco_stage2_20240927T133857_keepup.root
\tHists: np04hd_raw_run027310_0530_dataflow1_datawriter_0_20240620T030150_reco_stage1_reco_stage2_20240927T133857_keepup_hists.root
Forming reco metadata
Successfully opened file np04hd_raw_run027310_0530_dataflow1_datawriter_0_20240620T030150_reco_stage1_reco_stage2_20240927T133857_keepup.root
Ran successfully
{
  "name": "np04hd_raw_run027310_0530_dataflow1_datawriter_0_20240620T030150_reco_stage1_reco_stage2_20240927T133857_keepup.root",
  "namespace": "hd-protodune-det-reco",
  "metadata": {
    "core.file_format": "artroot",
    "core.application.name": "reco",
    "core.application.family": "dunesw",
    "core.application.version": "v09_91_02d01",
    "core.data_tier": "full-reconstructed",
    "dune.config_file": "standard_reco_stage2_calibration_protodunehd_keepup.fcl",
    "dune.campaign": "hd-protodune-reco-keepup-v0",
    "core.start_time": 1727437998.0,
    "core.end_time": 1727444338.0,
    "core.events": [
      74245,
      74249,
      74253,
      74257,
      74261,
      74265,
      74269,
      74273,
      74277,
      74281,
      74285,
      74289,
      74293,
      74297,
      74301,
      74305,
      74309,
      74313,
      74317,
      74321,
      74325,
      74329,
      74333,
      74337,
      74341,
      74345,
      74349,
      74353,
      74357,
      74361,
      74365,
      74369,
      74373,
      74377,
      74381
    ],
    "core.event_count": 35,
    "core.first_event_number": 74245,
    "core.last_event_number": 74381,
    "core.data_stream": "physics",
    "core.file_content_status": "good",
    "core.file_type": "detector",
    "core.run_type": "hd-protodune",
    "core.runs": [
      27310
    ],
    "core.runs_subruns": [
      2731000001
    ],
    "dune.daq_test": false,
    "retention.status": "active",
    "retention.class": "physics",
    "origin.applications.config_files": {
      "reco1": "standard_reco_stage1_protodunehd_keepup.fcl"
    },
    "origin.applications.versions": {
      "reco1": "v09_91_02d01"
    },
    "origin.applications.names": [
      "reco1"
    ]
  },
  "parents": [
    {
      "did": "hd-protodune:np04hd_raw_run027310_0530_dataflow1_datawriter_0_20240620T030150.hdf5"
    }
  ]
}Forming hist metadata
formed
{
  "name": "np04hd_raw_run027310_0530_dataflow1_datawriter_0_20240620T030150_reco_stage1_reco_stage2_20240927T133857_keepup_hists.root",
  "namespace": "hd-protodune-det-reco",
  "metadata": {
    "core.file_format": "root",
    "core.application.name": "reco",
    "core.application.family": "dunesw",
    "core.application.version": "v09_91_02d01",
    "core.data_tier": "root-tuple-virtual",
    "dune.config_file": "standard_reco_stage2_calibration_protodunehd_keepup.fcl",
    "dune.campaign": "hd-protodune-reco-keepup-v0",
    "core.start_time": 1727437998.0,
    "core.end_time": 1727444338.0,
    "core.data_stream": "physics",
    "core.file_content_status": "good",
    "core.file_type": "detector",
    "core.run_type": "hd-protodune",
    "core.runs": [
      27310
    ],
    "core.runs_subruns": [
      2731000001
    ],
    "dune.daq_test": false,
    "retention.status": "active",
    "retention.class": "physics",
    "origin.applications.config_files": {
      "reco1": "standard_reco_stage1_protodunehd_keepup.fcl"
    },
    "origin.applications.versions": {
      "reco1": "v09_91_02d01"
    },
    "origin.applications.names": [
      "reco1"
    ]
  },
  "parents": [
    {
      "did": "hd-protodune:np04hd_raw_run027310_0530_dataflow1_datawriter_0_20240620T030150.hdf5"
    }
  ]
}
justIN time: 2024-09-29 09:34:54 UTC       justIN version: 01.01.08