Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries --ompython_omhome=/usr Buildings_9_Buildings.Fluid.Storage.Examples.ExpansionVessel.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/Buildings 9.1.2-maint.9.1.x/package.mo", uses=false)
Using package Buildings with version 9.1.2 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 9.1.2-maint.9.1.x/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(Buildings.Fluid.Storage.Examples.ExpansionVessel,tolerance=1e-06,outputFormat="mat",numberOfIntervals=5000,variableFilter="time|vol.T|expVes.port_a.p",fileNamePrefix="Buildings_9_Buildings.Fluid.Storage.Examples.ExpansionVessel")
translateModel(Buildings.Fluid.Storage.Examples.ExpansionVessel,tolerance=1e-06,outputFormat="mat",numberOfIntervals=5000,variableFilter="time|vol.T|expVes.port_a.p",fileNamePrefix="Buildings_9_Buildings.Fluid.Storage.Examples.ExpansionVessel")
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.0.0+maint.om/package.mo): time 0.0008373/0.0008374, allocations: 92 kB / 15.06 MB, free: 1.098 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.0009273/0.0009274, allocations: 172.7 kB / 15.95 MB, free: 208 kB / 14.72 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.0.0+maint.om/package.mo): time 1.381/1.381, allocations: 223.3 MB / 240 MB, free: 5.285 MB / 190.1 MB
Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Buildings 9.1.2-maint.9.1.x/package.mo): time 2.424/2.424, allocations: 390.9 MB / 0.666 GB, free: 2.43 MB / 0.5137 GB
Notification: Performance of FrontEnd - loaded program: time 0.0003817/0.0003822, allocations: 8 kB / 0.8153 GB, free: 13.59 MB / 0.67 GB
Notification: Performance of FrontEnd - Absyn->SCode: time 0.7368/0.7372, allocations: 142.4 MB / 0.9544 GB, free: 7.711 MB / 0.7169 GB
Notification: Performance of NFInst.instantiate(Buildings.Fluid.Storage.Examples.ExpansionVessel): time 0.01367/0.751, allocations: 13.2 MB / 0.9673 GB, free: 13.16 MB / 0.7325 GB
Notification: Performance of NFInst.instExpressions: time 0.00528/0.7563, allocations: 3.412 MB / 0.9706 GB, free: 10.39 MB / 0.7325 GB
Notification: Performance of NFInst.updateImplicitVariability: time 0.0006908/0.757, allocations: 17.41 kB / 0.9707 GB, free: 10.38 MB / 0.7325 GB
Notification: Performance of NFTyping.typeComponents: time 0.0006751/0.7577, allocations: 149.2 kB / 0.9708 GB, free: 10.26 MB / 0.7325 GB
Notification: Performance of NFTyping.typeBindings: time 0.001534/0.7592, allocations: 487.3 kB / 0.9713 GB, free: 9.879 MB / 0.7325 GB
Notification: Performance of NFTyping.typeClassSections: time 0.0009488/0.7602, allocations: 287.4 kB / 0.9715 GB, free: 9.68 MB / 0.7325 GB
Notification: Performance of NFFlatten.flatten: time 0.001838/0.7621, allocations: 1.247 MB / 0.9728 GB, free: 8.938 MB / 0.7325 GB
Notification: Performance of NFFlatten.resolveConnections: time 0.0005375/0.7626, allocations: 243 kB / 0.973 GB, free: 8.781 MB / 0.7325 GB
Notification: Performance of NFEvalConstants.evaluate: time 0.000668/0.7633, allocations: 313.7 kB / 0.9733 GB, free: 8.621 MB / 0.7325 GB
Notification: Performance of NFSimplifyModel.simplify: time 0.0004064/0.7637, allocations: 279.7 kB / 0.9736 GB, free: 8.461 MB / 0.7325 GB
Notification: Performance of NFPackage.collectConstants: time 4.389e-05/0.7638, allocations: 13.94 kB / 0.9736 GB, free: 8.461 MB / 0.7325 GB
Notification: Performance of NFFlatten.collectFunctions: time 0.0004865/0.7642, allocations: 150 kB / 0.9737 GB, free: 8.391 MB / 0.7325 GB
Notification: Performance of NFScalarize.scalarize: time 9.18e-05/0.7643, allocations: 65.19 kB / 0.9738 GB, free: 8.344 MB / 0.7325 GB
Notification: Performance of NFVerifyModel.verify: time 0.0001104/0.7645, allocations: 100 kB / 0.9739 GB, free: 8.277 MB / 0.7325 GB
Notification: Performance of NFConvertDAE.convert: time 0.0004773/0.765, allocations: 433.4 kB / 0.9743 GB, free: 7.992 MB / 0.7325 GB
Notification: Performance of FrontEnd - DAE generated: time 4.939e-06/0.765, allocations: 0 / 0.9743 GB, free: 7.992 MB / 0.7325 GB
Notification: Performance of FrontEnd: time 2.064e-06/0.765, allocations: 0.9688 kB / 0.9743 GB, free: 7.992 MB / 0.7325 GB
Notification: Performance of Transformations before backend: time 6.792e-06/0.765, allocations: 0 / 0.9743 GB, free: 7.992 MB / 0.7325 GB
Notification: Model statistics after passing the front-end and creating the data structures used by the back-end:
 * Number of equations: 62
 * Number of variables: 62
Notification: Performance of Generate backend data structure: time 0.001041/0.766, allocations: 0.6742 MB / 0.9749 GB, free: 7.387 MB / 0.7325 GB
Notification: Performance of prepare preOptimizeDAE: time 3.399e-05/0.7661, allocations: 12.62 kB / 0.975 GB, free: 7.383 MB / 0.7325 GB
Notification: Performance of preOpt normalInlineFunction (simulation): time 0.0001737/0.7663, allocations: 48.39 kB / 0.975 GB, free: 7.359 MB / 0.7325 GB
Notification: Performance of preOpt evaluateParameters (simulation): time 0.0007036/0.767, allocations: 463.9 kB / 0.9754 GB, free: 6.961 MB / 0.7325 GB
Notification: Performance of preOpt simplifyIfEquations (simulation): time 2.542e-05/0.767, allocations: 20.75 kB / 0.9755 GB, free: 6.953 MB / 0.7325 GB
Notification: Performance of preOpt expandDerOperator (simulation): time 5.968e-05/0.7671, allocations: 29.58 kB / 0.9755 GB, free: 6.941 MB / 0.7325 GB
Notification: Performance of preOpt clockPartitioning (simulation): time 0.0005991/0.7677, allocations: 308.1 kB / 0.9758 GB, free: 6.734 MB / 0.7325 GB
Notification: Performance of preOpt findStateOrder (simulation): time 1.789e-05/0.7677, allocations: 7.844 kB / 0.9758 GB, free: 6.727 MB / 0.7325 GB
Notification: Performance of preOpt replaceEdgeChange (simulation): time 3.117e-05/0.7677, allocations: 11.12 kB / 0.9758 GB, free: 6.719 MB / 0.7325 GB
Notification: Performance of preOpt inlineArrayEqn (simulation): time 2.178e-05/0.7678, allocations: 11.36 kB / 0.9758 GB, free: 6.715 MB / 0.7325 GB
Notification: Performance of preOpt removeEqualRHS (simulation): time 0.0004564/0.7682, allocations: 203.2 kB / 0.976 GB, free: 6.621 MB / 0.7325 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.001724/0.77, allocations: 1.488 MB / 0.9775 GB, free: 5.242 MB / 0.7325 GB
Notification: Performance of preOpt comSubExp (simulation): time 0.0004408/0.7704, allocations: 174.7 kB / 0.9776 GB, free: 5.145 MB / 0.7325 GB
Notification: Performance of preOpt resolveLoops (simulation): time 0.0001727/0.7706, allocations: 74.31 kB / 0.9777 GB, free: 5.105 MB / 0.7325 GB
Notification: Performance of preOpt evalFunc (simulation): time 0.0001533/0.7708, allocations: 84.58 kB / 0.9778 GB, free: 5.012 MB / 0.7325 GB
Notification: Performance of preOpt encapsulateWhenConditions (simulation): time 0.0002985/0.7711, allocations: 141.9 kB / 0.9779 GB, free: 4.906 MB / 0.7325 GB
Notification: Performance of pre-optimization done (n=15): time 1.884e-06/0.7711, allocations: 0 / 0.9779 GB, free: 4.906 MB / 0.7325 GB
Notification: Performance of matching and sorting (n=15): time 0.0006217/0.7717, allocations: 242.5 kB / 0.9781 GB, free: 4.789 MB / 0.7325 GB
Notification: Performance of inlineWhenForInitialization (initialization): time 3.726e-05/0.7718, allocations: 68.53 kB / 0.9782 GB, free: 4.711 MB / 0.7325 GB
Notification: Performance of selectInitializationVariablesDAE (initialization): time 0.0003578/0.7721, allocations: 335.6 kB / 0.9785 GB, free: 4.488 MB / 0.7325 GB
Notification: Performance of collectPreVariables (initialization): time 2.658e-05/0.7722, allocations: 31.95 kB / 0.9786 GB, free: 4.453 MB / 0.7325 GB
Notification: Performance of collectInitialEqns (initialization): time 0.0001477/0.7723, allocations: 212.9 kB / 0.9788 GB, free: 4.262 MB / 0.7325 GB
Notification: Performance of collectInitialBindings (initialization): time 5.409e-05/0.7724, allocations: 58.31 kB / 0.9788 GB, free: 4.211 MB / 0.7325 GB
Notification: Performance of simplifyInitialFunctions (initialization): time 1.421e-05/0.7724, allocations: 5.719 kB / 0.9788 GB, free: 4.207 MB / 0.7325 GB
Notification: Performance of setup shared object (initialization): time 0.0001117/0.7725, allocations: 345.4 kB / 0.9792 GB, free: 3.867 MB / 0.7325 GB
Notification: Performance of preBalanceInitialSystem (initialization): time 0.0001884/0.7727, allocations: 73.52 kB / 0.9792 GB, free: 3.832 MB / 0.7325 GB
Notification: Performance of partitionIndependentBlocks (initialization): time 0.0002317/0.773, allocations: 147.6 kB / 0.9794 GB, free: 3.703 MB / 0.7325 GB
Notification: Performance of analyzeInitialSystem (initialization): time 0.0002332/0.7732, allocations: 120.4 kB / 0.9795 GB, free: 3.629 MB / 0.7325 GB
Notification: Performance of solveInitialSystemEqSystem (initialization): time 3.306e-06/0.7732, allocations: 1.031 kB / 0.9795 GB, free: 3.629 MB / 0.7325 GB
Notification: Performance of matching and sorting (n=30) (initialization): time 0.000591/0.7738, allocations: 320.6 kB / 0.9798 GB, free: 3.445 MB / 0.7325 GB
Notification: Performance of prepare postOptimizeDAE: time 3.547e-05/0.7738, allocations: 33.17 kB / 0.9798 GB, free: 3.414 MB / 0.7325 GB
Notification: Performance of postOpt simplifyComplexFunction (initialization): time 9.267e-06/0.7739, allocations: 2.312 kB / 0.9798 GB, free: 3.414 MB / 0.7325 GB
Notification: Performance of postOpt tearingSystem (initialization): time 1.553e-05/0.7739, allocations: 8.656 kB / 0.9798 GB, free: 3.41 MB / 0.7325 GB
Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.0002279/0.7741, allocations: 56.03 kB / 0.9799 GB, free: 3.398 MB / 0.7325 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 1.306e-05/0.7741, allocations: 15.36 kB / 0.9799 GB, free: 3.387 MB / 0.7325 GB
Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.0002573/0.7744, allocations: 38.05 kB / 0.9799 GB, free: 3.367 MB / 0.7325 GB
Notification: Performance of postOpt collapseArrayExpressions (initialization): time 2.739e-05/0.7744, allocations: 16.81 kB / 0.98 GB, free: 3.359 MB / 0.7325 GB
Notification: Model statistics after passing the back-end for initialization:
 * Number of independent subsystems: 11
 * Number of states: 0 ()
 * Number of discrete variables: 5 ($whenCondition1,$PRE.pulse.T_start,pulse.T_start,$PRE.pulse.count,pulse.count)
 * Number of discrete states: 0 ()
 * Number of clocked states: 0 ()
 * Top-level inputs: 0
Notification: Strong component statistics for initialization (29):
 * Single equations (assignments): 28
 * Array equations: 0
 * Algorithm blocks: 1
 * Record equations: 0
 * When equations: 0
 * If-equations: 0
 * Equation systems (linear and non-linear blocks): 0
 * Torn equation systems: 0
 * Mixed (continuous/discrete) equation systems: 0
Notification: Performance of prepare postOptimizeDAE: time 0.0001588/0.7746, allocations: 158 kB / 0.9801 GB, free: 3.215 MB / 0.7325 GB
Notification: Performance of postOpt lateInlineFunction (simulation): time 5.037e-05/0.7747, allocations: 35.88 kB / 0.9801 GB, free: 3.195 MB / 0.7325 GB
Notification: Performance of postOpt wrapFunctionCalls (simulation): time 0.0004551/0.7751, allocations: 204.3 kB / 0.9803 GB, free: 3.074 MB / 0.7325 GB
Notification: Performance of postOpt inlineArrayEqn (simulation): time 3.527e-06/0.7751, allocations: 2.688 kB / 0.9803 GB, free: 3.074 MB / 0.7325 GB
Notification: Performance of postOpt constantLinearSystem (simulation): time 5.14e-06/0.7751, allocations: 0 / 0.9803 GB, free: 3.074 MB / 0.7325 GB
Notification: Performance of postOpt simplifysemiLinear (simulation): time 0.0004762/0.7756, allocations: 0.4935 MB / 0.9808 GB, free: 2.57 MB / 0.7325 GB
Notification: Performance of postOpt removeSimpleEquations (simulation): time 0.0005114/0.7762, allocations: 349.4 kB / 0.9812 GB, free: 2.254 MB / 0.7325 GB
Notification: Performance of postOpt simplifyComplexFunction (simulation): time 2.825e-06/0.7762, allocations: 5.219 kB / 0.9812 GB, free: 2.25 MB / 0.7325 GB
Notification: Performance of postOpt solveSimpleEquations (simulation): time 0.0001836/0.7764, allocations: 33.77 kB / 0.9812 GB, free: 2.242 MB / 0.7325 GB
Notification: Performance of postOpt tearingSystem (simulation): time 4.068e-06/0.7764, allocations: 1 kB / 0.9812 GB, free: 2.242 MB / 0.7325 GB
Notification: Performance of postOpt inputDerivativesUsed (simulation): time 2.324e-05/0.7764, allocations: 5.453 kB / 0.9812 GB, free: 2.238 MB / 0.7325 GB
Notification: Performance of postOpt calculateStrongComponentJacobians (simulation): time 4.408e-06/0.7764, allocations: 1.406 kB / 0.9812 GB, free: 2.238 MB / 0.7325 GB
Notification: Performance of postOpt calculateStateSetsJacobians (simulation): time 1.433e-06/0.7764, allocations: 4 kB / 0.9812 GB, free: 2.234 MB / 0.7325 GB
Notification: Performance of postOpt symbolicJacobian (simulation): time 0.0007443/0.7772, allocations: 315.2 kB / 0.9815 GB, free: 2.043 MB / 0.7325 GB
Notification: Performance of postOpt removeConstants (simulation): time 0.0001824/0.7774, allocations: 129.7 kB / 0.9816 GB, free: 1.91 MB / 0.7325 GB
Notification: Performance of postOpt simplifyTimeIndepFuncCalls (simulation): time 6.599e-05/0.7774, allocations: 2.219 kB / 0.9816 GB, free: 1.91 MB / 0.7325 GB
Notification: Performance of postOpt simplifyAllExpressions (simulation): time 0.000247/0.7777, allocations: 20.52 kB / 0.9816 GB, free: 1.902 MB / 0.7325 GB
Notification: Performance of postOpt findZeroCrossings (simulation): time 8.916e-05/0.7778, allocations: 14.22 kB / 0.9817 GB, free: 1.895 MB / 0.7325 GB
Notification: Performance of postOpt collapseArrayExpressions (simulation): time 3.194e-05/0.7778, allocations: 14.58 kB / 0.9817 GB, free: 1.887 MB / 0.7325 GB
Notification: Performance of sorting global known variables: time 0.000305/0.7781, allocations: 234.5 kB / 0.9819 GB, free: 1.734 MB / 0.7325 GB
Notification: Performance of sort global known variables: time 3.91e-07/0.7781, allocations: 0 / 0.9819 GB, free: 1.734 MB / 0.7325 GB
Notification: Performance of remove unused functions: time 0.0005391/0.7787, allocations: 117.4 kB / 0.982 GB, free: 1.707 MB / 0.7325 GB
Notification: Model statistics after passing the back-end for simulation:
 * Number of independent subsystems: 1
 * Number of states: 3 (expVes.m,expVes.H,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 (15):
 * Single equations (assignments): 13
 * Array equations: 0
 * Algorithm blocks: 0
 * Record equations: 0
 * When equations: 2
 * If-equations: 0
 * Equation systems (linear and non-linear blocks): 0
 * Torn equation systems: 0
 * Mixed (continuous/discrete) equation systems: 0
Notification: Performance of Backend phase and start with SimCode phase: time 0.0004296/0.7791, allocations: 174.7 kB / 0.9822 GB, free: 1.582 MB / 0.7325 GB
Notification: Performance of simCode: created initialization part: time 0.0005802/0.7797, allocations: 241 kB / 0.9824 GB, free: 1.441 MB / 0.7325 GB
Notification: Performance of simCode: created event and clocks part: time 4.178e-06/0.7797, allocations: 0.625 kB / 0.9824 GB, free: 1.441 MB / 0.7325 GB
Notification: Performance of simCode: created simulation system equations: time 0.0002169/0.78, allocations: 72.78 kB / 0.9825 GB, free: 1.414 MB / 0.7325 GB
Notification: Performance of simCode: created of all other equations (e.g. parameter, nominal, assert, etc): time 0.001181/0.7812, allocations: 200.1 kB / 0.9827 GB, free: 1.32 MB / 0.7325 GB
Notification: Performance of simCode: created linear, non-linear and system jacobian parts: time 0.002214/0.7834, allocations: 0.9603 MB / 0.9836 GB, free: 0.5938 MB / 0.7325 GB
Notification: Performance of simCode: some other stuff during SimCode phase: time 0.0006119/0.784, allocations: 0.7874 MB / 0.9844 GB, free: 15.85 MB / 0.7481 GB
Notification: Performance of simCode: alias equations: time 0.0004217/0.7844, allocations: 72.08 kB / 0.9844 GB, free: 15.81 MB / 0.7481 GB
Notification: Performance of simCode: all other stuff during SimCode phase: time 0.0001063/0.7846, allocations: 33.78 kB / 0.9845 GB, free: 15.8 MB / 0.7481 GB
Notification: Performance of SimCode: time 2.4e-07/0.7846, allocations: 0 / 0.9845 GB, free: 15.8 MB / 0.7481 GB
Notification: Performance of Templates: time 0.0131/0.7977, allocations: 6.324 MB / 0.9906 GB, free: 9.805 MB / 0.7481 GB
make -j1 -f Buildings_9_Buildings.Fluid.Storage.Examples.ExpansionVessel.makefile
(rm -f Buildings_9_Buildings.Fluid.Storage.Examples.ExpansionVessel.pipe ; mkfifo Buildings_9_Buildings.Fluid.Storage.Examples.ExpansionVessel.pipe ; head -c 1048576 < Buildings_9_Buildings.Fluid.Storage.Examples.ExpansionVessel.pipe >> ../files/Buildings_9_Buildings.Fluid.Storage.Examples.ExpansionVessel.sim & ./Buildings_9_Buildings.Fluid.Storage.Examples.ExpansionVessel  -abortSlowSimulation -alarm=480  -emit_protected -lv LOG_STATS > Buildings_9_Buildings.Fluid.Storage.Examples.ExpansionVessel.pipe 2>&1)
diffSimulationResults("Buildings_9_Buildings.Fluid.Storage.Examples.ExpansionVessel_res.mat","/mnt/ReferenceFiles/Buildings/csv/maint_9.1.x/Buildings_Fluid_Storage_Examples_ExpansionVessel.csv","/var/lib/jenkins/ws/OpenModelicaLibraryTestingWork/OpenModelicaLibraryTesting/files/Buildings_9_Buildings.Fluid.Storage.Examples.ExpansionVessel.diff",relTol=0.003,relTolDiffMinMax=0.003,rangeDelta=0.001)
Reference file matches