Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries --ompython_omhome=/usr IDEAS_IDEAS.Fluid.Movers.Examples.PumpsParallel.conf.json
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.0.0+maint.om/package.mo", uses=false)
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 4.0.0+maint.om/package.mo", uses=false)
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.0.0+maint.om/package.mo", uses=false)
loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/IDEAS 3.0.0/package.mo", uses=false)
Using package IDEAS with version 3.0.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/IDEAS 3.0.0/package.mo)
Using package Modelica with version 4.0.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.0.0+maint.om/package.mo)
Using package Complex with version 4.0.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 4.0.0+maint.om/package.mo)
Using package ModelicaServices with version 4.0.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.0.0+maint.om/package.mo)
Running command: translateModel(IDEAS.Fluid.Movers.Examples.PumpsParallel,tolerance=1e-06,outputFormat="empty",numberOfIntervals=5000,variableFilter="",fileNamePrefix="IDEAS_IDEAS.Fluid.Movers.Examples.PumpsParallel")
translateModel(IDEAS.Fluid.Movers.Examples.PumpsParallel,tolerance=1e-06,outputFormat="empty",numberOfIntervals=5000,variableFilter="",fileNamePrefix="IDEAS_IDEAS.Fluid.Movers.Examples.PumpsParallel")
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.0.0+maint.om/package.mo): time 0.001273/0.001273, allocations: 118 kB / 16.42 MB, free: 6.445 MB / 14.72 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 4.0.0+maint.om/package.mo): time 0.001555/0.001556, allocations: 183.9 kB / 17.35 MB, free: 5.734 MB / 14.72 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.0.0+maint.om/package.mo): time 1.313/1.313, allocations: 222.9 MB / 241 MB, free: 15.15 MB / 206.1 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/IDEAS 3.0.0/package.mo): time 0.7743/0.7743, allocations: 132.2 MB / 423.4 MB, free: 6.578 MB / 334.1 MB
Notification: Performance of FrontEnd - loaded program: time 0.001187/0.001187, allocations: 65.69 kB / 0.582 GB, free: 23.72 MB / 446.1 MB
Notification: Performance of FrontEnd - Absyn->SCode: time 0.129/0.1302, allocations: 80.2 MB / 0.6603 GB, free: 10.29 MB / 0.4981 GB
Notification: Performance of NFInst.instantiate(IDEAS.Fluid.Movers.Examples.PumpsParallel): time 0.06604/0.1963, allocations: 67.1 MB / 0.7258 GB, free: 6.961 MB / 0.5606 GB
Notification: Performance of NFInst.instExpressions: time 0.02574/0.222, allocations: 19.38 MB / 0.7448 GB, free: 3.531 MB / 0.5762 GB
Notification: Performance of NFInst.updateImplicitVariability: time 0.002665/0.2247, allocations: 91.44 kB / 0.7449 GB, free: 3.441 MB / 0.5762 GB
Notification: Performance of NFTyping.typeComponents: time 0.003434/0.2282, allocations: 1.336 MB / 0.7462 GB, free: 2.098 MB / 0.5762 GB
Notification: Performance of NFTyping.typeBindings: time 0.3151/0.5433, allocations: 3.355 MB / 0.7494 GB, free: 5.117 MB / 0.5762 GB
Notification: Performance of NFTyping.typeClassSections: time 0.005387/0.5487, allocations: 2.384 MB / 0.7518 GB, free: 5.117 MB / 0.5762 GB
Notification: Performance of NFFlatten.flatten: time 0.007877/0.5566, allocations: 6.146 MB / 0.7578 GB, free: 5.113 MB / 0.5762 GB
Notification: Performance of NFFlatten.resolveConnections: time 0.004113/0.5608, allocations: 2.19 MB / 0.7599 GB, free: 4.867 MB / 0.5762 GB
Notification: Performance of NFEvalConstants.evaluate: time 0.00636/0.5671, allocations: 2.517 MB / 0.7624 GB, free: 4.832 MB / 0.5762 GB
Notification: Performance of NFSimplifyModel.simplify: time 0.003616/0.5708, allocations: 1.831 MB / 0.7642 GB, free: 4.516 MB / 0.5762 GB
Notification: Performance of NFPackage.collectConstants: time 0.0008353/0.5716, allocations: 230 kB / 0.7644 GB, free: 4.516 MB / 0.5762 GB
Notification: Performance of NFFlatten.collectFunctions: time 0.004753/0.5764, allocations: 1.813 MB / 0.7661 GB, free: 4.516 MB / 0.5762 GB
Notification: Performance of NFScalarize.scalarize: time 0.001169/0.5776, allocations: 0.7203 MB / 0.7668 GB, free: 4.422 MB / 0.5762 GB
Notification: Performance of NFVerifyModel.verify: time 0.002835/0.5804, allocations: 1.345 MB / 0.7682 GB, free: 4.039 MB / 0.5762 GB
Notification: Performance of NFConvertDAE.convert: time 0.0066/0.587, allocations: 4.168 MB / 0.7722 GB, free: 3.504 MB / 0.5762 GB
Notification: Performance of FrontEnd - DAE generated: time 4.528e-06/0.587, allocations: 3.938 kB / 0.7722 GB, free: 3.5 MB / 0.5762 GB
Notification: Performance of FrontEnd: time 1.863e-06/0.5871, allocations: 1.188 kB / 0.7722 GB, free: 3.5 MB / 0.5762 GB
Notification: Performance of Transformations before backend: time 0.0001136/0.5872, allocations: 0 / 0.7722 GB, free: 3.5 MB / 0.5762 GB
Notification: Model statistics after passing the front-end and creating the data structures used by the back-end:
 * Number of equations: 327
 * Number of variables: 327
Notification: Performance of Generate backend data structure: time 0.006743/0.5939, allocations: 2.951 MB / 0.7751 GB, free: 18.07 MB / 0.5919 GB
Notification: Performance of prepare preOptimizeDAE: time 4.21e-05/0.594, allocations: 9.25 kB / 0.7751 GB, free: 18.07 MB / 0.5919 GB
Notification: Performance of preOpt normalInlineFunction (simulation): time 0.00215/0.5961, allocations: 438.5 kB / 0.7755 GB, free: 17.92 MB / 0.5919 GB
Notification: Performance of preOpt evaluateParameters (simulation): time 0.004245/0.6004, allocations: 2.173 MB / 0.7777 GB, free: 17.34 MB / 0.5919 GB
Notification: Performance of preOpt simplifyIfEquations (simulation): time 8.081e-05/0.6005, allocations: 108.2 kB / 0.7778 GB, free: 17.33 MB / 0.5919 GB
Notification: Performance of preOpt expandDerOperator (simulation): time 0.0002186/0.6007, allocations: 144.8 kB / 0.7779 GB, free: 17.33 MB / 0.5919 GB
Notification: Performance of preOpt clockPartitioning (simulation): time 0.002616/0.6033, allocations: 1.541 MB / 0.7794 GB, free: 17.12 MB / 0.5919 GB
Notification: Performance of preOpt findStateOrder (simulation): time 3.172e-05/0.6034, allocations: 5.125 kB / 0.7794 GB, free: 17.12 MB / 0.5919 GB
Notification: Performance of preOpt replaceEdgeChange (simulation): time 0.0001292/0.6035, allocations: 51.41 kB / 0.7795 GB, free: 17.12 MB / 0.5919 GB
Notification: Performance of preOpt inlineArrayEqn (simulation): time 4.875e-05/0.6036, allocations: 49.95 kB / 0.7795 GB, free: 17.11 MB / 0.5919 GB
Notification: Performance of preOpt removeEqualRHS (simulation): time 0.002184/0.6058, allocations: 1.152 MB / 0.7806 GB, free: 17.09 MB / 0.5919 GB
Warning: The model contains alias variables with redundant start and/or conflicting nominal values. It is recommended to resolve the conflicts, because otherwise the system could be hard to solve. To print the conflicting alias sets and the chosen candidates please use -d=aliasConflicts.
Notification: Performance of preOpt removeSimpleEquations (simulation): time 0.008875/0.6146, allocations: 7.671 MB / 0.7881 GB, free: 13.04 MB / 0.5919 GB
Notification: Performance of preOpt comSubExp (simulation): time 0.001926/0.6166, allocations: 0.9536 MB / 0.7891 GB, free: 13 MB / 0.5919 GB
Notification: Performance of preOpt resolveLoops (simulation): time 0.0009182/0.6175, allocations: 0.5396 MB / 0.7896 GB, free: 12.98 MB / 0.5919 GB
Warning: The model contains alias variables with redundant start and/or conflicting nominal values. It is recommended to resolve the conflicts, because otherwise the system could be hard to solve. To print the conflicting alias sets and the chosen candidates please use -d=aliasConflicts.
Notification: Performance of preOpt evalFunc (simulation): time 0.003743/0.6213, allocations: 2.519 MB / 0.7921 GB, free: 11.77 MB / 0.5919 GB
Notification: Performance of preOpt encapsulateWhenConditions (simulation): time 2.964e-05/0.6213, allocations: 42.97 kB / 0.7921 GB, free: 11.73 MB / 0.5919 GB
Notification: Performance of preOpt simplifyInStream (simulation): time 0.0007026/0.622, allocations: 107 kB / 0.7922 GB, free: 11.69 MB / 0.5919 GB
Notification: Performance of pre-optimization done (n=83): time 3.636e-06/0.622, allocations: 0 / 0.7922 GB, free: 11.69 MB / 0.5919 GB
Notification: Performance of matching and sorting (n=83): time 0.006848/0.6289, allocations: 2.191 MB / 0.7943 GB, free: 11.39 MB / 0.5919 GB
Notification: Performance of inlineWhenForInitialization (initialization): time 3.49e-05/0.629, allocations: 59.94 kB / 0.7944 GB, free: 11.33 MB / 0.5919 GB
Notification: Performance of selectInitializationVariablesDAE (initialization): time 0.002624/0.6316, allocations: 1.814 MB / 0.7962 GB, free: 10.46 MB / 0.5919 GB
Notification: Performance of collectPreVariables (initialization): time 0.0001402/0.6317, allocations: 48.95 kB / 0.7962 GB, free: 10.41 MB / 0.5919 GB
Notification: Performance of collectInitialEqns (initialization): time 0.0008994/0.6326, allocations: 1.002 MB / 0.7972 GB, free: 9.531 MB / 0.5919 GB
Notification: Performance of collectInitialBindings (initialization): time 0.0003014/0.633, allocations: 288.1 kB / 0.7975 GB, free: 9.289 MB / 0.5919 GB
Notification: Performance of simplifyInitialFunctions (initialization): time 0.0003749/0.6333, allocations: 261.7 kB / 0.7977 GB, free: 9.141 MB / 0.5919 GB
Notification: Performance of setup shared object (initialization): time 0.0001463/0.6335, allocations: 356.5 kB / 0.7981 GB, free: 8.797 MB / 0.5919 GB
Notification: Performance of preBalanceInitialSystem (initialization): time 0.0009616/0.6345, allocations: 496.4 kB / 0.7985 GB, free: 8.555 MB / 0.5919 GB
Notification: Performance of partitionIndependentBlocks (initialization): time 0.001217/0.6357, allocations: 0.8998 MB / 0.7994 GB, free: 7.785 MB / 0.5919 GB
Notification: Performance of analyzeInitialSystem (initialization): time 0.002129/0.6378, allocations: 1.314 MB / 0.8007 GB, free: 6.934 MB / 0.5919 GB
Notification: Performance of solveInitialSystemEqSystem (initialization): time 8.416e-06/0.6378, allocations: 7.75 kB / 0.8007 GB, free: 6.934 MB / 0.5919 GB
Notification: Performance of matching and sorting (n=139) (initialization): time 0.003116/0.641, allocations: 1.682 MB / 0.8023 GB, free: 6.148 MB / 0.5919 GB
Notification: Performance of prepare postOptimizeDAE: time 2.002e-05/0.641, allocations: 7.5 kB / 0.8023 GB, free: 6.148 MB / 0.5919 GB
Notification: Performance of postOpt simplifyComplexFunction (initialization): time 1.493e-05/0.641, allocations: 11 kB / 0.8024 GB, free: 6.148 MB / 0.5919 GB
Notification: Performance of postOpt tearingSystem (initialization): time 0.001229/0.6423, allocations: 320.2 kB / 0.8027 GB, free: 6.016 MB / 0.5919 GB
Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.0009621/0.6432, allocations: 260 kB / 0.8029 GB, free: 5.961 MB / 0.5919 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 0.0008774/0.6441, allocations: 0.8544 MB / 0.8037 GB, free: 5.281 MB / 0.5919 GB
Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.001486/0.6456, allocations: 71.94 kB / 0.8038 GB, free: 5.242 MB / 0.5919 GB
Notification: Performance of postOpt collapseArrayExpressions (initialization): time 0.0001243/0.6458, allocations: 70.19 kB / 0.8039 GB, free: 5.223 MB / 0.5919 GB
Notification: Performance of preBalanceInitialSystem (initialization_lambda0): time 0.001437/0.6472, allocations: 0.7976 MB / 0.8047 GB, free: 4.754 MB / 0.5919 GB
Notification: Performance of partitionIndependentBlocks (initialization_lambda0): time 0.0009816/0.6482, allocations: 0.8239 MB / 0.8055 GB, free: 4.023 MB / 0.5919 GB
Notification: Performance of analyzeInitialSystem (initialization_lambda0): time 0.001645/0.6498, allocations: 1.184 MB / 0.8066 GB, free: 3.234 MB / 0.5919 GB
Notification: Performance of solveInitialSystemEqSystem (initialization_lambda0): time 4.949e-06/0.6499, allocations: 5.469 kB / 0.8066 GB, free: 3.234 MB / 0.5919 GB
Notification: Performance of matching and sorting (n=139) (initialization_lambda0): time 0.003094/0.653, allocations: 1.598 MB / 0.8082 GB, free: 2.504 MB / 0.5919 GB
Notification: Performance of prepare postOptimizeDAE: time 1.2e-05/0.653, allocations: 9.312 kB / 0.8082 GB, free: 2.504 MB / 0.5919 GB
Notification: Performance of postOpt simplifyComplexFunction (initialization): time 1.125e-05/0.653, allocations: 13.58 kB / 0.8082 GB, free: 2.5 MB / 0.5919 GB
Notification: Performance of postOpt tearingSystem (initialization): time 0.001171/0.6542, allocations: 319.5 kB / 0.8085 GB, free: 2.375 MB / 0.5919 GB
Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.0008454/0.655, allocations: 241.9 kB / 0.8087 GB, free: 2.328 MB / 0.5919 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 0.007144/0.6622, allocations: 4.492 MB / 0.8131 GB, free: 15.03 MB / 0.6075 GB
Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.001512/0.6637, allocations: 57.44 kB / 0.8132 GB, free: 15 MB / 0.6075 GB
Notification: Performance of postOpt collapseArrayExpressions (initialization): time 0.0001133/0.6638, allocations: 67.33 kB / 0.8132 GB, free: 14.98 MB / 0.6075 GB
Notification: Model statistics after passing the back-end for initialization:
 * Number of independent subsystems: 41
 * Number of states: 0 ()
 * Number of discrete variables: 0 ()
 * Number of discrete states: 0 ()
 * Number of clocked states: 0 ()
 * Top-level inputs: 0
Notification: Strong component statistics for initialization (118):
 * Single equations (assignments): 115
 * Array equations: 2
 * Algorithm blocks: 0
 * Record equations: 0
 * When equations: 0
 * If-equations: 0
 * Equation systems (not torn): 0
 * Torn equation systems: 1
 * Mixed (continuous/discrete) equation systems: 0
Notification: Torn system details for strict tearing set:
 * Linear torn systems (#iteration vars, #inner vars, density): 0 systems
 * Non-linear torn systems (#iteration vars, #inner vars): 1 system
   {(2,18)}
Notification: Performance of prepare postOptimizeDAE: time 0.0003689/0.6642, allocations: 257.8 kB / 0.8135 GB, free: 14.76 MB / 0.6075 GB
Notification: Performance of postOpt lateInlineFunction (simulation): time 0.0003262/0.6645, allocations: 196.4 kB / 0.8137 GB, free: 14.65 MB / 0.6075 GB
Notification: Performance of postOpt wrapFunctionCalls (simulation): time 0.003183/0.6677, allocations: 1.549 MB / 0.8152 GB, free: 13.68 MB / 0.6075 GB
Notification: Performance of postOpt simplifysemiLinear (simulation): time 0.002277/0.67, allocations: 1.223 MB / 0.8164 GB, free: 12.45 MB / 0.6075 GB
Notification: Performance of postOpt simplifyComplexFunction (simulation): time 5.119e-06/0.67, allocations: 0 / 0.8164 GB, free: 12.45 MB / 0.6075 GB
Notification: Performance of postOpt removeConstants (simulation): time 0.0007639/0.6708, allocations: 382.2 kB / 0.8168 GB, free: 12.06 MB / 0.6075 GB
Notification: Performance of postOpt simplifyTimeIndepFuncCalls (simulation): time 0.0002484/0.6711, allocations: 16 kB / 0.8168 GB, free: 12.04 MB / 0.6075 GB
Notification: Performance of postOpt simplifyAllExpressions (simulation): time 0.0009264/0.672, allocations: 51.95 kB / 0.8168 GB, free: 11.99 MB / 0.6075 GB
Notification: Performance of postOpt findZeroCrossings (simulation): time 0.0001488/0.6722, allocations: 88.19 kB / 0.8169 GB, free: 11.91 MB / 0.6075 GB
Notification: Performance of postOpt createDAEmodeBDAE (simulation): time 0.003006/0.6752, allocations: 1.301 MB / 0.8182 GB, free: 10.64 MB / 0.6075 GB
Notification: Performance of postOpt symbolicJacobianDAE (simulation): time 0.003023/0.6782, allocations: 1.844 MB / 0.82 GB, free: 8.801 MB / 0.6075 GB
Notification: Performance of postOpt setEvaluationStage (simulation): time 0.0008119/0.679, allocations: 463.7 kB / 0.8204 GB, free: 8.352 MB / 0.6075 GB
Notification: Performance of sorting global known variables: time 0.001796/0.6808, allocations: 1.229 MB / 0.8216 GB, free: 7.105 MB / 0.6075 GB
Notification: Performance of Backend: time 2.7e-07/0.6809, allocations: 0 / 0.8216 GB, free: 7.105 MB / 0.6075 GB
Notification: Performance of simCode: created initialization part: time 0.005736/0.6866, allocations: 2.37 MB / 0.8239 GB, free: 4.836 MB / 0.6075 GB
Notification: Performance of SimCode: time 0.007613/0.6942, allocations: 4.737 MB / 0.8286 GB, free: 124 kB / 0.6075 GB
Notification: Performance of Templates: time 0.07727/0.7715, allocations: 49.5 MB / 0.8769 GB, free: 15.23 MB / 0.67 GB
make -j1 -f IDEAS_IDEAS.Fluid.Movers.Examples.PumpsParallel.makefile
(rm -f IDEAS_IDEAS.Fluid.Movers.Examples.PumpsParallel.pipe ; mkfifo IDEAS_IDEAS.Fluid.Movers.Examples.PumpsParallel.pipe ; head -c 1048576 < IDEAS_IDEAS.Fluid.Movers.Examples.PumpsParallel.pipe >> ../files/IDEAS_IDEAS.Fluid.Movers.Examples.PumpsParallel.sim & ./IDEAS_IDEAS.Fluid.Movers.Examples.PumpsParallel  -abortSlowSimulation -alarm=480 -lv LOG_STATS > IDEAS_IDEAS.Fluid.Movers.Examples.PumpsParallel.pipe 2>&1)