Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries --ompython_omhome=/usr IDEAS_dev_IDEAS.Fluid.Humidifiers.Validation.SprayAirWasher_X_dynamic.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-master/package.mo", uses=false) Using package IDEAS with version 3.0.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/IDEAS 3.0.0-master/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.Humidifiers.Validation.SprayAirWasher_X_dynamic,tolerance=1e-06,outputFormat="empty",numberOfIntervals=5000,variableFilter="",fileNamePrefix="IDEAS_dev_IDEAS.Fluid.Humidifiers.Validation.SprayAirWasher_X_dynamic") translateModel(IDEAS.Fluid.Humidifiers.Validation.SprayAirWasher_X_dynamic,tolerance=1e-06,outputFormat="empty",numberOfIntervals=5000,variableFilter="",fileNamePrefix="IDEAS_dev_IDEAS.Fluid.Humidifiers.Validation.SprayAirWasher_X_dynamic") Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.0.0+maint.om/package.mo): time 0.001101/0.001101, allocations: 108 kB / 15.61 MB, free: 148 kB / 14.72 MB Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 4.0.0+maint.om/package.mo): time 0.001235/0.001235, allocations: 197.1 kB / 16.53 MB, free: 6.656 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.34/1.34, allocations: 222.9 MB / 240.2 MB, free: 4.402 MB / 190.1 MB Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/IDEAS 3.0.0-master/package.mo): time 0.9288/0.9288, allocations: 135.1 MB / 425.5 MB, free: 12.03 MB / 350.1 MB Notification: Performance of FrontEnd - loaded program: time 0.001222/0.001223, allocations: 61.88 kB / 0.5053 GB, free: 5.34 MB / 414.1 MB Notification: Performance of FrontEnd - Absyn->SCode: time 0.1668/0.168, allocations: 80.92 MB / 0.5844 GB, free: 4.578 MB / 494.1 MB Notification: Performance of NFInst.instantiate(IDEAS.Fluid.Humidifiers.Validation.SprayAirWasher_X_dynamic): time 0.5225/0.6906, allocations: 180.3 MB / 0.7604 GB, free: 8.68 MB / 0.5762 GB Notification: Performance of NFInst.instExpressions: time 0.01073/0.7013, allocations: 3.741 MB / 0.7641 GB, free: 4.926 MB / 0.5762 GB Notification: Performance of NFInst.updateImplicitVariability: time 0.001185/0.7026, allocations: 27.81 kB / 0.7641 GB, free: 4.898 MB / 0.5762 GB Notification: Performance of NFTyping.typeComponents: time 0.001661/0.7043, allocations: 433.5 kB / 0.7645 GB, free: 4.473 MB / 0.5762 GB Notification: Performance of NFTyping.typeBindings: time 0.004537/0.7088, allocations: 1.241 MB / 0.7657 GB, free: 3.227 MB / 0.5762 GB Notification: Performance of NFTyping.typeClassSections: time 0.002607/0.7115, allocations: 0.7483 MB / 0.7665 GB, free: 2.484 MB / 0.5762 GB Notification: Performance of NFFlatten.flatten: time 0.002358/0.7138, allocations: 1.356 MB / 0.7678 GB, free: 1.125 MB / 0.5762 GB Notification: Performance of NFFlatten.resolveConnections: time 0.0007394/0.7146, allocations: 481.3 kB / 0.7683 GB, free: 0.6562 MB / 0.5762 GB Notification: Performance of NFEvalConstants.evaluate: time 0.003165/0.7178, allocations: 0.9719 MB / 0.7692 GB, free: 15.69 MB / 0.5919 GB Notification: Performance of NFSimplifyModel.simplify: time 0.0008528/0.7186, allocations: 458.1 kB / 0.7696 GB, free: 15.24 MB / 0.5919 GB Notification: Performance of NFPackage.collectConstants: time 0.0001069/0.7188, allocations: 48 kB / 0.7697 GB, free: 15.19 MB / 0.5919 GB Notification: Performance of NFFlatten.collectFunctions: time 0.003002/0.7218, allocations: 1.193 MB / 0.7708 GB, free: 14 MB / 0.5919 GB Notification: Performance of NFScalarize.scalarize: time 0.0002784/0.7221, allocations: 195.4 kB / 0.771 GB, free: 13.8 MB / 0.5919 GB Notification: Performance of NFVerifyModel.verify: time 0.000536/0.7226, allocations: 330.2 kB / 0.7713 GB, free: 13.48 MB / 0.5919 GB Notification: Performance of NFConvertDAE.convert: time 0.00272/0.7254, allocations: 1.192 MB / 0.7725 GB, free: 12.29 MB / 0.5919 GB Notification: Performance of FrontEnd - DAE generated: time 6.202e-06/0.7254, allocations: 3.984 kB / 0.7725 GB, free: 12.28 MB / 0.5919 GB Notification: Performance of FrontEnd: time 4.779e-06/0.7254, allocations: 0 / 0.7725 GB, free: 12.28 MB / 0.5919 GB Notification: Performance of Transformations before backend: time 3.762e-05/0.7254, allocations: 3.938 kB / 0.7725 GB, free: 12.28 MB / 0.5919 GB Notification: Model statistics after passing the front-end and creating the data structures used by the back-end: * Number of equations: 97 * Number of variables: 97 Notification: Performance of Generate backend data structure: time 0.003144/0.7286, allocations: 1.052 MB / 0.7735 GB, free: 11.18 MB / 0.5919 GB Notification: Performance of prepare preOptimizeDAE: time 4.74e-05/0.7286, allocations: 12.03 kB / 0.7736 GB, free: 11.17 MB / 0.5919 GB Notification: Performance of preOpt normalInlineFunction (simulation): time 0.001998/0.7306, allocations: 215 kB / 0.7738 GB, free: 10.96 MB / 0.5919 GB Notification: Performance of preOpt evaluateParameters (simulation): time 0.001158/0.7318, allocations: 0.5459 MB / 0.7743 GB, free: 10.37 MB / 0.5919 GB Notification: Performance of preOpt simplifyIfEquations (simulation): time 5.521e-05/0.7319, allocations: 29 kB / 0.7743 GB, free: 10.34 MB / 0.5919 GB Notification: Performance of preOpt expandDerOperator (simulation): time 0.0001128/0.732, allocations: 44 kB / 0.7744 GB, free: 10.3 MB / 0.5919 GB Notification: Performance of preOpt clockPartitioning (simulation): time 0.001555/0.7336, allocations: 0.5396 MB / 0.7749 GB, free: 9.742 MB / 0.5919 GB Notification: Performance of preOpt findStateOrder (simulation): time 1.847e-05/0.7336, allocations: 7.938 kB / 0.7749 GB, free: 9.734 MB / 0.5919 GB Notification: Performance of preOpt replaceEdgeChange (simulation): time 6.87e-05/0.7337, allocations: 12.81 kB / 0.7749 GB, free: 9.723 MB / 0.5919 GB Notification: Performance of preOpt inlineArrayEqn (simulation): time 4.014e-05/0.7337, allocations: 17 kB / 0.7749 GB, free: 9.707 MB / 0.5919 GB Notification: Performance of preOpt removeEqualRHS (simulation): time 0.001784/0.7355, allocations: 0.4957 MB / 0.7754 GB, free: 9.211 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.004663/0.7402, allocations: 2.226 MB / 0.7776 GB, free: 6.812 MB / 0.5919 GB Notification: Performance of preOpt comSubExp (simulation): time 0.001013/0.7413, allocations: 360.4 kB / 0.7779 GB, free: 6.434 MB / 0.5919 GB Notification: Performance of preOpt resolveLoops (simulation): time 0.000345/0.7416, allocations: 158.5 kB / 0.7781 GB, free: 6.277 MB / 0.5919 GB Notification: Performance of preOpt evalFunc (simulation): time 0.001998/0.7436, allocations: 0.8338 MB / 0.7789 GB, free: 5.277 MB / 0.5919 GB Notification: Performance of preOpt encapsulateWhenConditions (simulation): time 0.0005283/0.7442, allocations: 201.7 kB / 0.7791 GB, free: 5.062 MB / 0.5919 GB Notification: Performance of pre-optimization done (n=28): time 3.496e-06/0.7442, allocations: 0 / 0.7791 GB, free: 5.062 MB / 0.5919 GB Notification: Performance of matching and sorting (n=28): time 0.001714/0.7459, allocations: 462 kB / 0.7795 GB, free: 4.609 MB / 0.5919 GB Notification: Performance of inlineWhenForInitialization (initialization): time 7.774e-05/0.746, allocations: 77.11 kB / 0.7796 GB, free: 4.516 MB / 0.5919 GB Notification: Performance of selectInitializationVariablesDAE (initialization): time 0.001449/0.7475, allocations: 0.6525 MB / 0.7802 GB, free: 3.852 MB / 0.5919 GB Notification: Performance of collectPreVariables (initialization): time 5.962e-05/0.7476, allocations: 29.7 kB / 0.7803 GB, free: 3.816 MB / 0.5919 GB Notification: Performance of collectInitialEqns (initialization): time 0.0003552/0.7479, allocations: 323.7 kB / 0.7806 GB, free: 3.496 MB / 0.5919 GB Notification: Performance of collectInitialBindings (initialization): time 0.0001241/0.7481, allocations: 102.6 kB / 0.7807 GB, free: 3.395 MB / 0.5919 GB Notification: Performance of simplifyInitialFunctions (initialization): time 0.0002217/0.7483, allocations: 78.12 kB / 0.7807 GB, free: 3.312 MB / 0.5919 GB Notification: Performance of setup shared object (initialization): time 0.0002131/0.7485, allocations: 370.8 kB / 0.7811 GB, free: 2.941 MB / 0.5919 GB Notification: Performance of preBalanceInitialSystem (initialization): time 0.0005977/0.7491, allocations: 154.1 kB / 0.7813 GB, free: 2.793 MB / 0.5919 GB Notification: Performance of partitionIndependentBlocks (initialization): time 0.000763/0.7499, allocations: 298.2 kB / 0.7815 GB, free: 2.434 MB / 0.5919 GB Notification: Performance of analyzeInitialSystem (initialization): time 0.001026/0.7509, allocations: 408.8 kB / 0.7819 GB, free: 1.98 MB / 0.5919 GB Notification: Performance of solveInitialSystemEqSystem (initialization): time 8.806e-06/0.751, allocations: 4 kB / 0.7819 GB, free: 1.977 MB / 0.5919 GB Notification: Performance of matching and sorting (n=47) (initialization): time 0.001716/0.7527, allocations: 496.7 kB / 0.7824 GB, free: 1.484 MB / 0.5919 GB Notification: Performance of prepare postOptimizeDAE: time 3.421e-05/0.7527, allocations: 10.22 kB / 0.7824 GB, free: 1.477 MB / 0.5919 GB Notification: Performance of postOpt simplifyComplexFunction (initialization): time 1.685e-05/0.7528, allocations: 8 kB / 0.7824 GB, free: 1.469 MB / 0.5919 GB Notification: Performance of postOpt tearingSystem (initialization): time 3.349e-05/0.7528, allocations: 8 kB / 0.7824 GB, free: 1.461 MB / 0.5919 GB Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.0006893/0.7535, allocations: 91.83 kB / 0.7825 GB, free: 1.371 MB / 0.5919 GB Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 2.27e-05/0.7536, allocations: 8 kB / 0.7825 GB, free: 1.363 MB / 0.5919 GB Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.000988/0.7546, allocations: 79.39 kB / 0.7826 GB, free: 1.285 MB / 0.5919 GB Notification: Performance of postOpt collapseArrayExpressions (initialization): time 8.108e-05/0.7546, allocations: 27.92 kB / 0.7826 GB, free: 1.258 MB / 0.5919 GB Notification: Performance of preBalanceInitialSystem (initialization_lambda0): time 0.0008636/0.7555, allocations: 308.4 kB / 0.7829 GB, free: 0.957 MB / 0.5919 GB Notification: Performance of partitionIndependentBlocks (initialization_lambda0): time 0.0007348/0.7563, allocations: 306.2 kB / 0.7832 GB, free: 0.5938 MB / 0.5919 GB Notification: Performance of analyzeInitialSystem (initialization_lambda0): time 0.0009887/0.7573, allocations: 403.1 kB / 0.7836 GB, free: 148 kB / 0.5919 GB Notification: Performance of solveInitialSystemEqSystem (initialization_lambda0): time 3.807e-06/0.7573, allocations: 0 / 0.7836 GB, free: 148 kB / 0.5919 GB Notification: Performance of matching and sorting (n=47) (initialization_lambda0): time 0.001666/0.759, allocations: 489.5 kB / 0.7841 GB, free: 15.66 MB / 0.6075 GB Notification: Performance of prepare postOptimizeDAE: time 1.894e-05/0.759, allocations: 4.469 kB / 0.7841 GB, free: 15.66 MB / 0.6075 GB Notification: Performance of postOpt simplifyComplexFunction (initialization): time 9.738e-06/0.759, allocations: 8 kB / 0.7841 GB, free: 15.65 MB / 0.6075 GB Notification: Performance of postOpt tearingSystem (initialization): time 1.439e-05/0.7591, allocations: 8 kB / 0.7841 GB, free: 15.64 MB / 0.6075 GB Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.0006648/0.7597, allocations: 91.88 kB / 0.7842 GB, free: 15.55 MB / 0.6075 GB Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 2.238e-05/0.7598, allocations: 13.5 kB / 0.7842 GB, free: 15.54 MB / 0.6075 GB Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.001001/0.7608, allocations: 63.7 kB / 0.7842 GB, free: 15.48 MB / 0.6075 GB Notification: Performance of postOpt collapseArrayExpressions (initialization): time 6.944e-05/0.7609, allocations: 20 kB / 0.7843 GB, free: 15.46 MB / 0.6075 GB Notification: Model statistics after passing the back-end for initialization: * Number of independent subsystems: 18 * Number of states: 0 () * Number of discrete variables: 5 ($PRE.XSet.nextTimeEvent,$whenCondition1,XSet.nextTimeEventScaled,$PRE.XSet.nextTimeEventScaled,XSet.nextTimeEvent) * Number of discrete states: 0 () * Number of clocked states: 0 () * Top-level inputs: 0 Notification: Strong component statistics for initialization (47): * Single equations (assignments): 47 * Array equations: 0 * Algorithm blocks: 0 * Record equations: 0 * When equations: 0 * If-equations: 0 * Equation systems (not torn): 0 * Torn equation systems: 0 * Mixed (continuous/discrete) equation systems: 0 Notification: Performance of prepare postOptimizeDAE: time 0.0002947/0.7612, allocations: 212.1 kB / 0.7845 GB, free: 15.24 MB / 0.6075 GB Notification: Performance of postOpt lateInlineFunction (simulation): time 0.0001674/0.7613, allocations: 63.25 kB / 0.7845 GB, free: 15.18 MB / 0.6075 GB Notification: Performance of postOpt wrapFunctionCalls (simulation): time 0.001019/0.7624, allocations: 339.6 kB / 0.7848 GB, free: 14.83 MB / 0.6075 GB Notification: Performance of postOpt inlineArrayEqn (simulation): time 7.874e-06/0.7624, allocations: 7.938 kB / 0.7849 GB, free: 14.82 MB / 0.6075 GB Notification: Performance of postOpt constantLinearSystem (simulation): time 8.095e-06/0.7624, allocations: 0 / 0.7849 GB, free: 14.82 MB / 0.6075 GB Notification: Performance of postOpt simplifysemiLinear (simulation): time 7.163e-06/0.7624, allocations: 0 / 0.7849 GB, free: 14.82 MB / 0.6075 GB Notification: Performance of postOpt removeSimpleEquations (simulation): time 0.002251/0.7647, allocations: 1.116 MB / 0.7859 GB, free: 13.62 MB / 0.6075 GB Notification: Performance of postOpt simplifyComplexFunction (simulation): time 6.111e-06/0.7647, allocations: 4.125 kB / 0.7859 GB, free: 13.61 MB / 0.6075 GB Notification: Performance of postOpt solveSimpleEquations (simulation): time 0.0002768/0.765, allocations: 44.3 kB / 0.786 GB, free: 13.57 MB / 0.6075 GB Notification: Performance of postOpt tearingSystem (simulation): time 8.946e-06/0.765, allocations: 8 kB / 0.786 GB, free: 13.56 MB / 0.6075 GB Notification: Performance of postOpt inputDerivativesUsed (simulation): time 3.587e-05/0.7651, allocations: 15.97 kB / 0.786 GB, free: 13.55 MB / 0.6075 GB Notification: Performance of postOpt calculateStrongComponentJacobians (simulation): time 1.071e-05/0.7651, allocations: 7.938 kB / 0.786 GB, free: 13.54 MB / 0.6075 GB Notification: Performance of postOpt calculateStateSetsJacobians (simulation): time 4.899e-06/0.7651, allocations: 4 kB / 0.786 GB, free: 13.54 MB / 0.6075 GB Notification: Performance of postOpt symbolicJacobian (simulation): time 0.001011/0.7661, allocations: 0.618 MB / 0.7866 GB, free: 12.87 MB / 0.6075 GB Notification: Performance of postOpt removeConstants (simulation): time 0.0002358/0.7664, allocations: 164.3 kB / 0.7868 GB, free: 12.69 MB / 0.6075 GB Notification: Performance of postOpt simplifyTimeIndepFuncCalls (simulation): time 0.0001001/0.7665, allocations: 10.69 kB / 0.7868 GB, free: 12.68 MB / 0.6075 GB Notification: Performance of postOpt simplifyAllExpressions (simulation): time 0.0004212/0.7669, allocations: 24.05 kB / 0.7868 GB, free: 12.66 MB / 0.6075 GB Notification: Performance of postOpt findZeroCrossings (simulation): time 8.561e-05/0.767, allocations: 27.84 kB / 0.7868 GB, free: 12.63 MB / 0.6075 GB Notification: Performance of postOpt collapseArrayExpressions (simulation): time 2.926e-05/0.767, allocations: 12 kB / 0.7869 GB, free: 12.62 MB / 0.6075 GB Notification: Performance of sorting global known variables: time 0.0008299/0.7679, allocations: 479 kB / 0.7873 GB, free: 12.16 MB / 0.6075 GB Notification: Performance of sort global known variables: time 2.1e-07/0.7679, allocations: 3.938 kB / 0.7873 GB, free: 12.15 MB / 0.6075 GB Notification: Performance of remove unused functions: time 0.001141/0.769, allocations: 267.7 kB / 0.7876 GB, free: 11.89 MB / 0.6075 GB Notification: Model statistics after passing the back-end for simulation: * Number of independent subsystems: 11 * Number of states: 2 (hum.outCon.T,hum.outCon.Xi) * Number of discrete variables: 3 ($whenCondition1,XSet.nextTimeEvent,XSet.nextTimeEventScaled) * Number of discrete states: 2 (XSet.nextTimeEvent,XSet.nextTimeEventScaled) * Number of clocked states: 0 () * Top-level inputs: 0 Notification: Strong component statistics for simulation (27): * Single equations (assignments): 25 * Array equations: 0 * Algorithm blocks: 0 * Record equations: 0 * When equations: 2 * If-equations: 0 * Equation systems (not torn): 0 * Torn equation systems: 0 * Mixed (continuous/discrete) equation systems: 0 Notification: Performance of Backend phase and start with SimCode phase: time 0.001473/0.7705, allocations: 0.5072 MB / 0.7881 GB, free: 11.58 MB / 0.6075 GB Notification: Performance of simCode: created initialization part: time 0.001537/0.7721, allocations: 0.5469 MB / 0.7886 GB, free: 11.04 MB / 0.6075 GB Notification: Performance of simCode: created event and clocks part: time 3.416e-06/0.7721, allocations: 0 / 0.7886 GB, free: 11.04 MB / 0.6075 GB Notification: Performance of simCode: created simulation system equations: time 0.0002305/0.7723, allocations: 131.8 kB / 0.7887 GB, free: 10.91 MB / 0.6075 GB Notification: Performance of simCode: created of all other equations (e.g. parameter, nominal, assert, etc): time 0.001345/0.7737, allocations: 296.8 kB / 0.789 GB, free: 10.63 MB / 0.6075 GB Notification: Performance of simCode: created linear, non-linear and system jacobian parts: time 0.002136/0.7758, allocations: 1.163 MB / 0.7901 GB, free: 9.414 MB / 0.6075 GB Notification: Performance of simCode: some other stuff during SimCode phase: time 0.0005142/0.7763, allocations: 0.9017 MB / 0.791 GB, free: 8.484 MB / 0.6075 GB Notification: Performance of simCode: alias equations: time 0.0006889/0.777, allocations: 161 kB / 0.7912 GB, free: 8.328 MB / 0.6075 GB Notification: Performance of simCode: all other stuff during SimCode phase: time 0.0001216/0.7772, allocations: 47.38 kB / 0.7912 GB, free: 8.285 MB / 0.6075 GB Notification: Performance of SimCode: time 6.11e-07/0.7772, allocations: 0 / 0.7912 GB, free: 8.285 MB / 0.6075 GB Notification: Performance of Templates: time 0.02073/0.7979, allocations: 10.65 MB / 0.8016 GB, free: 13.79 MB / 0.6231 GB make -j1 -f IDEAS_dev_IDEAS.Fluid.Humidifiers.Validation.SprayAirWasher_X_dynamic.makefile (rm -f IDEAS_dev_IDEAS.Fluid.Humidifiers.Validation.SprayAirWasher_X_dynamic.pipe ; mkfifo IDEAS_dev_IDEAS.Fluid.Humidifiers.Validation.SprayAirWasher_X_dynamic.pipe ; head -c 1048576 < IDEAS_dev_IDEAS.Fluid.Humidifiers.Validation.SprayAirWasher_X_dynamic.pipe >> ../files/IDEAS_dev_IDEAS.Fluid.Humidifiers.Validation.SprayAirWasher_X_dynamic.sim & ./IDEAS_dev_IDEAS.Fluid.Humidifiers.Validation.SprayAirWasher_X_dynamic -abortSlowSimulation -alarm=480 -lv LOG_STATS > IDEAS_dev_IDEAS.Fluid.Humidifiers.Validation.SprayAirWasher_X_dynamic.pipe 2>&1)