Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries/ --ompython_omhome=/usr IDEAS_IDEAS.Fluid.Examples.Performance.Example3.conf.json 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/IDEAS 3.0.0/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/ModelicaServices 4.0.0+maint.om/package.mo", uses=false) Using package ModelicaServices with version 4.0.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.0.0+maint.om/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 IDEAS with version 3.0.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/IDEAS 3.0.0/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) Running command: translateModel(IDEAS.Fluid.Examples.Performance.Example3,tolerance=1e-06,outputFormat="empty",numberOfIntervals=5000,variableFilter="",fileNamePrefix="IDEAS_IDEAS.Fluid.Examples.Performance.Example3") translateModel(IDEAS.Fluid.Examples.Performance.Example3,tolerance=1e-06,outputFormat="empty",numberOfIntervals=5000,variableFilter="",fileNamePrefix="IDEAS_IDEAS.Fluid.Examples.Performance.Example3") Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 4.0.0+maint.om/package.mo): time 0.001076/0.001076, allocations: 183.2 kB / 15.98 MB, free: 5.77 MB / 13.93 MB Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/IDEAS 3.0.0/package.mo): time 0.7272/0.7272, allocations: 132.2 MB / 148.9 MB, free: 12.16 MB / 122.7 MB Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.0.0+maint.om/package.mo): time 1.351/1.351, allocations: 222.9 MB / 403.3 MB, free: 7.133 MB / 314.7 MB Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.0.0+maint.om/package.mo): time 0.001051/0.001051, allocations: 109.2 kB / 484.3 MB, free: 8.73 MB / 394.7 MB Notification: Performance of FrontEnd - loaded program: time 0.001107/0.001108, allocations: 59.89 kB / 0.5618 GB, free: 71.06 MB / 426.7 MB Notification: Performance of FrontEnd - Absyn->SCode: time 0.1358/0.1369, allocations: 80.2 MB / 0.6402 GB, free: 6.793 MB / 442.7 MB Notification: Performance of NFInst.instantiate(IDEAS.Fluid.Examples.Performance.Example3): time 0.02773/0.1646, allocations: 32.57 MB / 0.672 GB, free: 6.098 MB / 474.7 MB Notification: Performance of NFInst.instExpressions: time 0.01357/0.1782, allocations: 10.56 MB / 0.6823 GB, free: 11.51 MB / 490.7 MB Notification: Performance of NFInst.updateImplicitVariability: time 0.00162/0.1799, allocations: 47.69 kB / 0.6823 GB, free: 11.46 MB / 490.7 MB Notification: Performance of NFTyping.typeComponents: time 0.001848/0.1818, allocations: 0.6378 MB / 0.6829 GB, free: 10.82 MB / 490.7 MB Notification: Performance of NFTyping.typeBindings: time 0.003336/0.1852, allocations: 1.453 MB / 0.6844 GB, free: 9.363 MB / 490.7 MB Notification: Performance of NFTyping.typeClassSections: time 0.002807/0.188, allocations: 1.257 MB / 0.6856 GB, free: 8.113 MB / 490.7 MB Notification: Performance of NFFlatten.flatten: time 0.005614/0.1936, allocations: 6.463 MB / 0.6919 GB, free: 1.637 MB / 490.7 MB Notification: Performance of NFFlatten.resolveConnections: time 0.3129/0.5065, allocations: 1.761 MB / 0.6936 GB, free: 13.21 MB / 490.7 MB Notification: Performance of NFEvalConstants.evaluate: time 0.004499/0.511, allocations: 1.68 MB / 0.6953 GB, free: 13.21 MB / 490.7 MB Notification: Performance of NFSimplifyModel.simplify: time 0.002645/0.5137, allocations: 1.379 MB / 0.6966 GB, free: 12.95 MB / 490.7 MB Notification: Performance of NFPackage.collectConstants: time 0.0003264/0.514, allocations: 81.78 kB / 0.6967 GB, free: 12.95 MB / 490.7 MB Notification: Performance of NFFlatten.collectFunctions: time 0.002812/0.5169, allocations: 1.104 MB / 0.6978 GB, free: 12.95 MB / 490.7 MB Notification: Performance of NFScalarize.scalarize: time 0.0005691/0.5174, allocations: 408.6 kB / 0.6982 GB, free: 12.88 MB / 490.7 MB Notification: Performance of NFVerifyModel.verify: time 0.001499/0.5189, allocations: 0.9422 MB / 0.6991 GB, free: 12.57 MB / 490.7 MB Notification: Performance of NFConvertDAE.convert: time 0.004569/0.5235, allocations: 2.842 MB / 0.7019 GB, free: 12.23 MB / 490.7 MB Notification: Performance of FrontEnd - DAE generated: time 5.32e-06/0.5235, allocations: 0 / 0.7019 GB, free: 12.23 MB / 490.7 MB Notification: Performance of FrontEnd: time 1.322e-06/0.5236, allocations: 1.406 kB / 0.7019 GB, free: 12.23 MB / 490.7 MB Notification: Performance of Transformations before backend: time 4.591e-05/0.5236, allocations: 0 / 0.7019 GB, free: 12.23 MB / 490.7 MB Notification: Model statistics after passing the front-end and creating the data structures used by the back-end: * Number of equations: 235 * Number of variables: 235 Notification: Performance of Generate backend data structure: time 0.004557/0.5282, allocations: 2.387 MB / 0.7042 GB, free: 10.99 MB / 490.7 MB Notification: Performance of prepare preOptimizeDAE: time 4.534e-05/0.5282, allocations: 13.16 kB / 0.7042 GB, free: 10.99 MB / 490.7 MB Notification: Performance of preOpt normalInlineFunction (simulation): time 0.001197/0.5294, allocations: 299.4 kB / 0.7045 GB, free: 10.88 MB / 490.7 MB Notification: Performance of preOpt evaluateParameters (simulation): time 0.00326/0.5327, allocations: 1.644 MB / 0.7061 GB, free: 10.4 MB / 490.7 MB Notification: Performance of preOpt simplifyIfEquations (simulation): time 7.792e-05/0.5328, allocations: 86.09 kB / 0.7062 GB, free: 10.4 MB / 490.7 MB Notification: Performance of preOpt expandDerOperator (simulation): time 0.0001579/0.533, allocations: 103.9 kB / 0.7063 GB, free: 10.4 MB / 490.7 MB Notification: Performance of preOpt clockPartitioning (simulation): time 0.002269/0.5352, allocations: 1.283 MB / 0.7075 GB, free: 10.17 MB / 490.7 MB Notification: Performance of preOpt findStateOrder (simulation): time 2.868e-05/0.5353, allocations: 9.719 kB / 0.7075 GB, free: 10.16 MB / 490.7 MB Notification: Performance of preOpt replaceEdgeChange (simulation): time 0.0001062/0.5354, allocations: 40.72 kB / 0.7076 GB, free: 10.16 MB / 490.7 MB Notification: Performance of preOpt inlineArrayEqn (simulation): time 2.78e-05/0.5354, allocations: 25.66 kB / 0.7076 GB, free: 10.16 MB / 490.7 MB Notification: Performance of preOpt removeEqualRHS (simulation): time 0.002068/0.5375, allocations: 0.9852 MB / 0.7086 GB, free: 10.15 MB / 490.7 MB 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.00735/0.5449, allocations: 6.737 MB / 0.7151 GB, free: 6.062 MB / 490.7 MB Notification: Performance of preOpt comSubExp (simulation): time 0.001304/0.5462, allocations: 0.5852 MB / 0.7157 GB, free: 6.031 MB / 490.7 MB Notification: Performance of preOpt resolveLoops (simulation): time 0.0006568/0.5469, allocations: 400.1 kB / 0.7161 GB, free: 6.016 MB / 490.7 MB Notification: Performance of preOpt evalFunc (simulation): time 0.002621/0.5495, allocations: 1.688 MB / 0.7177 GB, free: 5.117 MB / 490.7 MB Notification: Performance of preOpt encapsulateWhenConditions (simulation): time 0.0007111/0.5502, allocations: 361.8 kB / 0.7181 GB, free: 5.062 MB / 490.7 MB Notification: Performance of preOpt simplifyInStream (simulation): time 0.0004844/0.5507, allocations: 109.5 kB / 0.7182 GB, free: 5.027 MB / 490.7 MB Notification: Performance of pre-optimization done (n=46): time 2.134e-06/0.5507, allocations: 0 / 0.7182 GB, free: 5.027 MB / 490.7 MB Notification: Performance of matching and sorting (n=46): time 0.003213/0.5539, allocations: 1.283 MB / 0.7194 GB, free: 4.77 MB / 490.7 MB Notification: Performance of inlineWhenForInitialization (initialization): time 3.314e-05/0.554, allocations: 71.33 kB / 0.7195 GB, free: 4.699 MB / 490.7 MB Notification: Performance of selectInitializationVariablesDAE (initialization): time 0.0023/0.5563, allocations: 1.782 MB / 0.7213 GB, free: 4.469 MB / 490.7 MB Notification: Performance of collectPreVariables (initialization): time 5.916e-05/0.5564, allocations: 43.42 kB / 0.7213 GB, free: 4.438 MB / 490.7 MB Notification: Performance of collectInitialEqns (initialization): time 0.0006362/0.557, allocations: 0.8517 MB / 0.7221 GB, free: 4.172 MB / 490.7 MB Notification: Performance of collectInitialBindings (initialization): time 0.0001255/0.5571, allocations: 163.4 kB / 0.7223 GB, free: 4.07 MB / 490.7 MB Notification: Performance of simplifyInitialFunctions (initialization): time 0.0002617/0.5574, allocations: 186.3 kB / 0.7225 GB, free: 4.047 MB / 490.7 MB Notification: Performance of setup shared object (initialization): time 6.284e-05/0.5575, allocations: 337.5 kB / 0.7228 GB, free: 3.742 MB / 490.7 MB Notification: Performance of preBalanceInitialSystem (initialization): time 0.0006242/0.5581, allocations: 318.2 kB / 0.7231 GB, free: 3.73 MB / 490.7 MB Notification: Performance of partitionIndependentBlocks (initialization): time 0.0008569/0.559, allocations: 0.7321 MB / 0.7238 GB, free: 3.188 MB / 490.7 MB Notification: Performance of analyzeInitialSystem (initialization): time 0.001561/0.5605, allocations: 0.9837 MB / 0.7248 GB, free: 2.762 MB / 490.7 MB Notification: Performance of solveInitialSystemEqSystem (initialization): time 1.231e-05/0.5606, allocations: 6.781 kB / 0.7248 GB, free: 2.762 MB / 490.7 MB Notification: Performance of matching and sorting (n=99) (initialization): time 0.002488/0.5631, allocations: 1.3 MB / 0.726 GB, free: 2.559 MB / 490.7 MB Notification: Performance of prepare postOptimizeDAE: time 3.903e-05/0.5631, allocations: 35.27 kB / 0.7261 GB, free: 2.527 MB / 490.7 MB Notification: Performance of postOpt simplifyComplexFunction (initialization): time 2.14e-05/0.5631, allocations: 11.41 kB / 0.7261 GB, free: 2.527 MB / 490.7 MB Notification: Performance of postOpt tearingSystem (initialization): time 0.0006388/0.5638, allocations: 196.3 kB / 0.7263 GB, free: 2.508 MB / 490.7 MB Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.0005709/0.5644, allocations: 163.5 kB / 0.7264 GB, free: 2.508 MB / 490.7 MB Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 0.0005262/0.5649, allocations: 0.7554 MB / 0.7272 GB, free: 1.988 MB / 490.7 MB Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.001208/0.5661, allocations: 90.22 kB / 0.7272 GB, free: 1.977 MB / 490.7 MB Notification: Performance of postOpt collapseArrayExpressions (initialization): time 8.759e-05/0.5662, allocations: 47.12 kB / 0.7273 GB, free: 1.977 MB / 490.7 MB Notification: Performance of preBalanceInitialSystem (initialization_lambda0): time 0.001169/0.5674, allocations: 0.7064 MB / 0.728 GB, free: 1.895 MB / 490.7 MB Notification: Performance of partitionIndependentBlocks (initialization_lambda0): time 0.0006936/0.5681, allocations: 0.7026 MB / 0.7287 GB, free: 1.352 MB / 490.7 MB Notification: Performance of analyzeInitialSystem (initialization_lambda0): time 0.001126/0.5692, allocations: 0.921 MB / 0.7296 GB, free: 0.9258 MB / 490.7 MB Notification: Performance of solveInitialSystemEqSystem (initialization_lambda0): time 6.122e-06/0.5693, allocations: 6.625 kB / 0.7296 GB, free: 0.9258 MB / 490.7 MB Notification: Performance of matching and sorting (n=99) (initialization_lambda0): time 0.001946/0.5712, allocations: 1.263 MB / 0.7308 GB, free: 436 kB / 490.7 MB Notification: Performance of prepare postOptimizeDAE: time 2.853e-05/0.5713, allocations: 40.69 kB / 0.7308 GB, free: 404 kB / 490.7 MB Notification: Performance of postOpt simplifyComplexFunction (initialization): time 1.063e-05/0.5713, allocations: 10.84 kB / 0.7309 GB, free: 404 kB / 490.7 MB Notification: Performance of postOpt tearingSystem (initialization): time 0.0002051/0.5715, allocations: 116.7 kB / 0.731 GB, free: 376 kB / 490.7 MB Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.0005103/0.572, allocations: 164.7 kB / 0.7311 GB, free: 368 kB / 490.7 MB Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 0.002041/0.5741, allocations: 2.125 MB / 0.7332 GB, free: 14.7 MB / 0.4948 GB Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.001132/0.5752, allocations: 92.39 kB / 0.7333 GB, free: 14.68 MB / 0.4948 GB Notification: Performance of postOpt collapseArrayExpressions (initialization): time 7.102e-05/0.5753, allocations: 47.34 kB / 0.7333 GB, free: 14.66 MB / 0.4948 GB Notification: Model statistics after passing the back-end for initialization: * Number of independent subsystems: 46 * Number of states: 0 () * Number of discrete variables: 8 (pulse.count,$PRE.pulse.count,pulse.T_start,$PRE.pulse.T_start,$whenCondition1,nRes.y,from_dp.y,mergeDp.y) * Number of discrete states: 0 () * Number of clocked states: 0 () * Top-level inputs: 0 Notification: Strong component statistics for initialization (85): * Single equations (assignments): 82 * Array equations: 1 * Algorithm blocks: 1 * 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 {(1,12)} Notification: Performance of prepare postOptimizeDAE: time 0.000313/0.5756, allocations: 246.4 kB / 0.7336 GB, free: 14.45 MB / 0.4948 GB Notification: Performance of postOpt lateInlineFunction (simulation): time 0.0002253/0.5758, allocations: 174.8 kB / 0.7337 GB, free: 14.36 MB / 0.4948 GB Notification: Performance of postOpt wrapFunctionCalls (simulation): time 0.002052/0.5779, allocations: 0.9725 MB / 0.7347 GB, free: 14 MB / 0.4948 GB Notification: Performance of postOpt inlineArrayEqn (simulation): time 1.25e-05/0.5779, allocations: 10.62 kB / 0.7347 GB, free: 14 MB / 0.4948 GB Notification: Performance of postOpt constantLinearSystem (simulation): time 2.184e-06/0.5779, allocations: 0 / 0.7347 GB, free: 14 MB / 0.4948 GB Notification: Performance of postOpt simplifysemiLinear (simulation): time 0.001462/0.5794, allocations: 0.9392 MB / 0.7356 GB, free: 13.42 MB / 0.4948 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 postOpt removeSimpleEquations (simulation): time 0.003839/0.5832, allocations: 2.168 MB / 0.7377 GB, free: 12.39 MB / 0.4948 GB Notification: Performance of postOpt simplifyComplexFunction (simulation): time 4.679e-06/0.5833, allocations: 0 / 0.7377 GB, free: 12.39 MB / 0.4948 GB Notification: Performance of postOpt solveSimpleEquations (simulation): time 0.0004005/0.5837, allocations: 83.91 kB / 0.7378 GB, free: 12.39 MB / 0.4948 GB Notification: Performance of postOpt tearingSystem (simulation): time 0.0002838/0.584, allocations: 128.7 kB / 0.7379 GB, free: 12.35 MB / 0.4948 GB Notification: Performance of postOpt inputDerivativesUsed (simulation): time 4.058e-05/0.584, allocations: 16.67 kB / 0.7379 GB, free: 12.35 MB / 0.4948 GB Notification: Performance of postOpt calculateStrongComponentJacobians (simulation): time 0.0005789/0.5846, allocations: 0.731 MB / 0.7387 GB, free: 11.74 MB / 0.4948 GB Notification: Performance of postOpt calculateStateSetsJacobians (simulation): time 1.864e-06/0.5846, allocations: 3.031 kB / 0.7387 GB, free: 11.74 MB / 0.4948 GB Notification: Performance of postOpt symbolicJacobian (simulation): time 0.02074/0.6054, allocations: 10.49 MB / 0.7489 GB, free: 4.277 MB / 0.4948 GB Notification: Performance of postOpt removeConstants (simulation): time 0.0005341/0.6059, allocations: 292.8 kB / 0.7492 GB, free: 4.031 MB / 0.4948 GB Notification: Performance of postOpt simplifyTimeIndepFuncCalls (simulation): time 0.000156/0.6061, allocations: 15.5 kB / 0.7492 GB, free: 4.02 MB / 0.4948 GB Notification: Performance of postOpt simplifyAllExpressions (simulation): time 0.0007459/0.6069, allocations: 69.73 kB / 0.7493 GB, free: 3.988 MB / 0.4948 GB Notification: Performance of postOpt findZeroCrossings (simulation): time 0.000116/0.607, allocations: 41.98 kB / 0.7493 GB, free: 3.965 MB / 0.4948 GB Notification: Performance of postOpt collapseArrayExpressions (simulation): time 4.81e-05/0.607, allocations: 17.7 kB / 0.7493 GB, free: 3.961 MB / 0.4948 GB Notification: Performance of sorting global known variables: time 0.001623/0.6087, allocations: 1.23 MB / 0.7505 GB, free: 3.281 MB / 0.4948 GB Notification: Performance of sort global known variables: time 1.2e-07/0.6087, allocations: 0 / 0.7505 GB, free: 3.281 MB / 0.4948 GB Notification: Performance of remove unused functions: time 0.003914/0.6126, allocations: 1.325 MB / 0.7518 GB, free: 2.918 MB / 0.4948 GB Notification: Model statistics after passing the back-end for simulation: * Number of independent subsystems: 3 * Number of states: 1 (pump.vol.dynBal.U) * Number of discrete variables: 3 ($whenCondition1,pulse.T_start,pulse.count) * Number of discrete states: 1 (pulse.count) * Number of clocked states: 0 () * Top-level inputs: 0 Notification: Strong component statistics for simulation (40): * Single equations (assignments): 34 * Array equations: 0 * Algorithm blocks: 0 * Record equations: 3 * When equations: 2 * 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 {(1,12)} Notification: Performance of Backend phase and start with SimCode phase: time 0.001188/0.6138, allocations: 454.2 kB / 0.7523 GB, free: 2.504 MB / 0.4948 GB Notification: Performance of simCode: created initialization part: time 0.002731/0.6165, allocations: 1.461 MB / 0.7537 GB, free: 1.07 MB / 0.4948 GB Notification: Performance of simCode: created event and clocks part: time 3.948e-06/0.6165, allocations: 0.6875 kB / 0.7537 GB, free: 1.07 MB / 0.4948 GB Notification: Performance of simCode: created simulation system equations: time 0.000704/0.6173, allocations: 329.3 kB / 0.754 GB, free: 0.7578 MB / 0.4948 GB Notification: Performance of simCode: created of all other equations (e.g. parameter, nominal, assert, etc): time 0.003278/0.6206, allocations: 0.7575 MB / 0.7547 GB, free: 20 kB / 0.4948 GB Notification: Performance of simCode: created linear, non-linear and system jacobian parts: time 0.005297/0.6259, allocations: 3.968 MB / 0.7586 GB, free: 12 MB / 0.5105 GB Notification: Performance of simCode: some other stuff during SimCode phase: time 0.0009749/0.6269, allocations: 1.524 MB / 0.7601 GB, free: 10.44 MB / 0.5105 GB Notification: Performance of simCode: alias equations: time 0.001689/0.6286, allocations: 458.3 kB / 0.7605 GB, free: 9.984 MB / 0.5105 GB Notification: Performance of simCode: all other stuff during SimCode phase: time 0.0003386/0.6289, allocations: 135.4 kB / 0.7607 GB, free: 9.852 MB / 0.5105 GB Notification: Performance of SimCode: time 6.61e-07/0.6289, allocations: 0 / 0.7607 GB, free: 9.852 MB / 0.5105 GB Notification: Performance of Templates: time 0.08712/0.716, allocations: 35.01 MB / 0.7949 GB, free: 7.391 MB / 0.5417 GB make -j1 -f IDEAS_IDEAS.Fluid.Examples.Performance.Example3.makefile (rm -f IDEAS_IDEAS.Fluid.Examples.Performance.Example3.pipe ; mkfifo IDEAS_IDEAS.Fluid.Examples.Performance.Example3.pipe ; head -c 1048576 < IDEAS_IDEAS.Fluid.Examples.Performance.Example3.pipe >> ../files/IDEAS_IDEAS.Fluid.Examples.Performance.Example3.sim & ./IDEAS_IDEAS.Fluid.Examples.Performance.Example3 -abortSlowSimulation -alarm=480 -lv LOG_STATS > IDEAS_IDEAS.Fluid.Examples.Performance.Example3.pipe 2>&1)