Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries --ompython_omhome=/usr IDEAS_dev_IDEAS.Fluid.Interfaces.Examples.ReverseFlowMassExchanger.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.Interfaces.Examples.ReverseFlowMassExchanger,tolerance=1e-06,outputFormat="empty",numberOfIntervals=5000,variableFilter="",fileNamePrefix="IDEAS_dev_IDEAS.Fluid.Interfaces.Examples.ReverseFlowMassExchanger") translateModel(IDEAS.Fluid.Interfaces.Examples.ReverseFlowMassExchanger,tolerance=1e-06,outputFormat="empty",numberOfIntervals=5000,variableFilter="",fileNamePrefix="IDEAS_dev_IDEAS.Fluid.Interfaces.Examples.ReverseFlowMassExchanger") Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.0.0+maint.om/package.mo): time 0.001144/0.001144, allocations: 117 kB / 16.37 MB, free: 6.012 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.001035/0.001035, allocations: 188.9 kB / 17.3 MB, free: 5.613 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.316/1.316, allocations: 222.9 MB / 241 MB, free: 15.14 MB / 206.1 MB Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/IDEAS 3.0.0-master/package.mo): time 0.7587/0.7587, allocations: 135.1 MB / 426.3 MB, free: 4.105 MB / 334.1 MB Notification: Performance of FrontEnd - loaded program: time 0.00121/0.001211, allocations: 59.91 kB / 0.5067 GB, free: 7.652 MB / 430.1 MB Notification: Performance of FrontEnd - Absyn->SCode: time 0.3649/0.3661, allocations: 80.91 MB / 0.5858 GB, free: 25.46 MB / 446.1 MB Notification: Performance of NFInst.instantiate(IDEAS.Fluid.Interfaces.Examples.ReverseFlowMassExchanger): time 0.6272/0.9934, allocations: 328.4 MB / 0.9065 GB, free: 5.164 MB / 0.6231 GB Notification: Performance of NFInst.instExpressions: time 0.0389/1.032, allocations: 30.05 MB / 0.9358 GB, free: 7.027 MB / 0.6544 GB Notification: Performance of NFInst.updateImplicitVariability: time 0.004148/1.037, allocations: 99.44 kB / 0.9359 GB, free: 6.93 MB / 0.6544 GB Notification: Performance of NFTyping.typeComponents: time 0.005794/1.042, allocations: 2.097 MB / 0.9379 GB, free: 4.82 MB / 0.6544 GB Notification: Performance of NFTyping.typeBindings: time 0.01302/1.055, allocations: 4.954 MB / 0.9428 GB, free: 15.84 MB / 0.67 GB Notification: Performance of NFTyping.typeClassSections: time 0.008877/1.064, allocations: 3.659 MB / 0.9464 GB, free: 12.21 MB / 0.67 GB Notification: Performance of NFFlatten.flatten: time 0.01077/1.075, allocations: 6.935 MB / 0.9531 GB, free: 5.262 MB / 0.67 GB Notification: Performance of NFFlatten.resolveConnections: time 0.004429/1.08, allocations: 2.859 MB / 0.9559 GB, free: 2.34 MB / 0.67 GB Notification: Performance of NFEvalConstants.evaluate: time 0.01257/1.092, allocations: 5.286 MB / 0.9611 GB, free: 13.06 MB / 0.6856 GB Notification: Performance of NFSimplifyModel.simplify: time 0.004625/1.097, allocations: 2.413 MB / 0.9634 GB, free: 10.65 MB / 0.6856 GB Notification: Performance of NFPackage.collectConstants: time 0.0007624/1.098, allocations: 296 kB / 0.9637 GB, free: 10.36 MB / 0.6856 GB Notification: Performance of NFFlatten.collectFunctions: time 0.008725/1.106, allocations: 4.809 MB / 0.9684 GB, free: 5.543 MB / 0.6856 GB Notification: Performance of NFScalarize.scalarize: time 0.001157/1.107, allocations: 1.067 MB / 0.9695 GB, free: 4.473 MB / 0.6856 GB Notification: Performance of NFVerifyModel.verify: time 0.002198/1.11, allocations: 1.738 MB / 0.9712 GB, free: 2.727 MB / 0.6856 GB Notification: Performance of NFConvertDAE.convert: time 0.008709/1.118, allocations: 5.742 MB / 0.9768 GB, free: 12.97 MB / 0.7012 GB Notification: Performance of FrontEnd - DAE generated: time 5.46e-06/1.118, allocations: 4 kB / 0.9768 GB, free: 12.96 MB / 0.7012 GB Notification: Performance of FrontEnd: time 1.272e-06/1.118, allocations: 0 / 0.9768 GB, free: 12.96 MB / 0.7012 GB Notification: Performance of Transformations before backend: time 4.956e-05/1.118, allocations: 4 kB / 0.9768 GB, free: 12.96 MB / 0.7012 GB Notification: Model statistics after passing the front-end and creating the data structures used by the back-end: * Number of equations: 536 * Number of variables: 536 Notification: Performance of Generate backend data structure: time 0.006954/1.125, allocations: 3.692 MB / 0.9804 GB, free: 9.184 MB / 0.7012 GB Notification: Performance of prepare preOptimizeDAE: time 3.719e-05/1.125, allocations: 13.11 kB / 0.9804 GB, free: 9.172 MB / 0.7012 GB Notification: Performance of preOpt normalInlineFunction (simulation): time 0.009198/1.135, allocations: 1.464 MB / 0.9818 GB, free: 7.703 MB / 0.7012 GB Notification: Performance of preOpt evaluateParameters (simulation): time 0.004344/1.139, allocations: 2.069 MB / 0.9838 GB, free: 5.555 MB / 0.7012 GB Notification: Performance of preOpt simplifyIfEquations (simulation): time 0.0001451/1.139, allocations: 168.1 kB / 0.984 GB, free: 5.387 MB / 0.7012 GB Notification: Performance of preOpt expandDerOperator (simulation): time 0.0003891/1.14, allocations: 220 kB / 0.9842 GB, free: 5.172 MB / 0.7012 GB Notification: Performance of preOpt clockPartitioning (simulation): time 0.005978/1.146, allocations: 3.039 MB / 0.9872 GB, free: 1.996 MB / 0.7012 GB Notification: Performance of preOpt findStateOrder (simulation): time 4.037e-05/1.146, allocations: 3.938 kB / 0.9872 GB, free: 1.992 MB / 0.7012 GB Notification: Performance of preOpt replaceEdgeChange (simulation): time 0.0002322/1.146, allocations: 92 kB / 0.9873 GB, free: 1.902 MB / 0.7012 GB Notification: Performance of preOpt inlineArrayEqn (simulation): time 8.454e-05/1.146, allocations: 92 kB / 0.9874 GB, free: 1.809 MB / 0.7012 GB Notification: Performance of preOpt removeEqualRHS (simulation): time 0.006599/1.153, allocations: 3.111 MB / 0.9904 GB, free: 14.68 MB / 0.7169 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.02134/1.174, allocations: 14.02 MB / 1.004 GB, free: 15.55 MB / 0.7325 GB Notification: Performance of preOpt comSubExp (simulation): time 0.00375/1.178, allocations: 1.658 MB / 1.006 GB, free: 13.89 MB / 0.7325 GB Notification: Performance of preOpt resolveLoops (simulation): time 0.001606/1.179, allocations: 0.7813 MB / 1.006 GB, free: 13.11 MB / 0.7325 GB Notification: Performance of preOpt evalFunc (simulation): time 0.0005768/1.18, allocations: 328.1 kB / 1.007 GB, free: 12.73 MB / 0.7325 GB Notification: Performance of preOpt encapsulateWhenConditions (simulation): time 4.253e-05/1.18, allocations: 51.5 kB / 1.007 GB, free: 12.67 MB / 0.7325 GB Notification: Performance of preOpt simplifyInStream (simulation): time 0.0009991/1.181, allocations: 202.1 kB / 1.007 GB, free: 12.47 MB / 0.7325 GB Notification: Performance of pre-optimization done (n=110): time 3.477e-06/1.181, allocations: 0 / 1.007 GB, free: 12.47 MB / 0.7325 GB Notification: Performance of matching and sorting (n=110): time 0.005352/1.186, allocations: 2.356 MB / 1.009 GB, free: 10.11 MB / 0.7325 GB Notification: Performance of inlineWhenForInitialization (initialization): time 4.432e-05/1.186, allocations: 64.41 kB / 1.009 GB, free: 10.04 MB / 0.7325 GB Notification: Performance of selectInitializationVariablesDAE (initialization): time 0.003759/1.19, allocations: 2.513 MB / 1.012 GB, free: 7.504 MB / 0.7325 GB Notification: Performance of collectPreVariables (initialization): time 0.0001793/1.19, allocations: 57.7 kB / 1.012 GB, free: 7.441 MB / 0.7325 GB Notification: Performance of collectInitialEqns (initialization): time 0.0009577/1.191, allocations: 1.272 MB / 1.013 GB, free: 6.152 MB / 0.7325 GB Notification: Performance of collectInitialBindings (initialization): time 0.0003065/1.192, allocations: 386.5 kB / 1.014 GB, free: 5.77 MB / 0.7325 GB Notification: Performance of simplifyInitialFunctions (initialization): time 0.0007146/1.192, allocations: 395 kB / 1.014 GB, free: 5.379 MB / 0.7325 GB Notification: Performance of setup shared object (initialization): time 0.0001911/1.193, allocations: 301.1 kB / 1.014 GB, free: 5.082 MB / 0.7325 GB Notification: Performance of preBalanceInitialSystem (initialization): time 0.00243/1.195, allocations: 0.9611 MB / 1.015 GB, free: 4.117 MB / 0.7325 GB Notification: Performance of partitionIndependentBlocks (initialization): time 0.003085/1.198, allocations: 1.588 MB / 1.017 GB, free: 2.258 MB / 0.7325 GB Notification: Performance of analyzeInitialSystem (initialization): time 0.004236/1.202, allocations: 2.257 MB / 1.019 GB, free: 15.8 MB / 0.7481 GB Notification: Performance of solveInitialSystemEqSystem (initialization): time 1.03e-05/1.202, allocations: 4 kB / 1.019 GB, free: 15.8 MB / 0.7481 GB Notification: Performance of matching and sorting (n=216) (initialization): time 0.006293/1.209, allocations: 2.782 MB / 1.022 GB, free: 12.99 MB / 0.7481 GB Notification: Performance of prepare postOptimizeDAE: time 6.676e-05/1.209, allocations: 79.42 kB / 1.022 GB, free: 12.9 MB / 0.7481 GB Notification: Performance of postOpt simplifyComplexFunction (initialization): time 1.964e-05/1.209, allocations: 12 kB / 1.022 GB, free: 12.89 MB / 0.7481 GB Notification: Performance of postOpt tearingSystem (initialization): time 3.458e-05/1.209, allocations: 24 kB / 1.022 GB, free: 12.87 MB / 0.7481 GB Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.002791/1.212, allocations: 0.5538 MB / 1.022 GB, free: 12.31 MB / 0.7481 GB Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 0.001368/1.213, allocations: 2.387 MB / 1.025 GB, free: 9.832 MB / 0.7481 GB Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.00298/1.216, allocations: 291.7 kB / 1.025 GB, free: 9.547 MB / 0.7481 GB Notification: Performance of postOpt collapseArrayExpressions (initialization): time 0.0001874/1.216, allocations: 95.94 kB / 1.025 GB, free: 9.453 MB / 0.7481 GB Notification: Performance of preBalanceInitialSystem (initialization_lambda0): time 0.003086/1.219, allocations: 1.39 MB / 1.026 GB, free: 8.059 MB / 0.7481 GB Notification: Performance of partitionIndependentBlocks (initialization_lambda0): time 0.002757/1.222, allocations: 1.591 MB / 1.028 GB, free: 6.191 MB / 0.7481 GB Notification: Performance of analyzeInitialSystem (initialization_lambda0): time 0.004305/1.226, allocations: 2.242 MB / 1.03 GB, free: 3.746 MB / 0.7481 GB Notification: Performance of solveInitialSystemEqSystem (initialization_lambda0): time 7.354e-06/1.226, allocations: 4 kB / 1.03 GB, free: 3.742 MB / 0.7481 GB Notification: Performance of matching and sorting (n=216) (initialization_lambda0): time 0.006203/1.233, allocations: 2.781 MB / 1.033 GB, free: 0.9375 MB / 0.7481 GB Notification: Performance of prepare postOptimizeDAE: time 5.703e-05/1.233, allocations: 75.33 kB / 1.033 GB, free: 0.8516 MB / 0.7481 GB Notification: Performance of postOpt simplifyComplexFunction (initialization): time 1.416e-05/1.233, allocations: 12 kB / 1.033 GB, free: 0.8398 MB / 0.7481 GB Notification: Performance of postOpt tearingSystem (initialization): time 2.421e-05/1.233, allocations: 28 kB / 1.033 GB, free: 0.8125 MB / 0.7481 GB Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.00234/1.235, allocations: 0.5115 MB / 1.033 GB, free: 308 kB / 0.7481 GB Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 2.647e-05/1.235, allocations: 27.88 kB / 1.033 GB, free: 280 kB / 0.7481 GB Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.2662/1.501, allocations: 292.8 kB / 1.034 GB, free: 325.3 MB / 0.7481 GB Notification: Performance of postOpt collapseArrayExpressions (initialization): time 0.0005203/1.502, allocations: 90.67 kB / 1.034 GB, free: 325.3 MB / 0.7481 GB Notification: Model statistics after passing the back-end for initialization: * Number of independent subsystems: 61 * Number of states: 0 () * Number of discrete variables: 4 (masExcRev.i2_w,masExcRev.i1_w,masExcFor.i2_w,masExcFor.i1_w) * Number of discrete states: 0 () * Number of clocked states: 0 () * Top-level inputs: 0 Notification: Strong component statistics for initialization (214): * Single equations (assignments): 208 * Array equations: 0 * Algorithm blocks: 2 * Record equations: 0 * When equations: 0 * If-equations: 0 * Equation systems (not torn): 4 * Torn equation systems: 0 * Mixed (continuous/discrete) equation systems: 0 Notification: Equation system details (not torn): * Constant Jacobian (size): 0 systems * Linear Jacobian (size,density): 0 systems * Non-linear Jacobian (size): 4 systems {1, 1, 1, 1} * Without analytic Jacobian (size): 0 systems Notification: Performance of prepare postOptimizeDAE: time 0.0006953/1.503, allocations: 298.4 kB / 1.034 GB, free: 325.1 MB / 0.7481 GB Notification: Performance of postOpt lateInlineFunction (simulation): time 0.0008301/1.503, allocations: 257.6 kB / 1.034 GB, free: 325.1 MB / 0.7481 GB Notification: Performance of postOpt wrapFunctionCalls (simulation): time 0.004426/1.508, allocations: 1.839 MB / 1.036 GB, free: 325 MB / 0.7481 GB Notification: Performance of postOpt inlineArrayEqn (simulation): time 1.302e-05/1.508, allocations: 10.5 kB / 1.036 GB, free: 325 MB / 0.7481 GB Notification: Performance of postOpt constantLinearSystem (simulation): time 7.333e-06/1.508, allocations: 1.266 kB / 1.036 GB, free: 325 MB / 0.7481 GB Notification: Performance of postOpt simplifysemiLinear (simulation): time 1.423e-05/1.508, allocations: 9.516 kB / 1.036 GB, free: 325 MB / 0.7481 GB Notification: Performance of postOpt removeSimpleEquations (simulation): time 0.008601/1.517, allocations: 4.491 MB / 1.04 GB, free: 323.2 MB / 0.7481 GB Notification: Performance of postOpt simplifyComplexFunction (simulation): time 1.558e-05/1.517, allocations: 5.875 kB / 1.04 GB, free: 323.2 MB / 0.7481 GB Notification: Performance of postOpt solveSimpleEquations (simulation): time 0.001702/1.518, allocations: 305.1 kB / 1.041 GB, free: 323.2 MB / 0.7481 GB Notification: Performance of postOpt tearingSystem (simulation): time 1.162e-05/1.518, allocations: 11.81 kB / 1.041 GB, free: 323.2 MB / 0.7481 GB Notification: Performance of postOpt inputDerivativesUsed (simulation): time 8.798e-05/1.518, allocations: 37.02 kB / 1.041 GB, free: 323.2 MB / 0.7481 GB Notification: Performance of postOpt calculateStrongComponentJacobians (simulation): time 0.0006623/1.519, allocations: 2.362 MB / 1.043 GB, free: 320.8 MB / 0.7481 GB Notification: Performance of postOpt calculateStateSetsJacobians (simulation): time 1.042e-05/1.519, allocations: 7.25 kB / 1.043 GB, free: 320.8 MB / 0.7481 GB Notification: Performance of postOpt symbolicJacobian (simulation): time 0.003853/1.523, allocations: 1.974 MB / 1.045 GB, free: 320 MB / 0.7481 GB Notification: Performance of postOpt removeConstants (simulation): time 0.001073/1.524, allocations: 0.5214 MB / 1.046 GB, free: 319.7 MB / 0.7481 GB Notification: Performance of postOpt simplifyTimeIndepFuncCalls (simulation): time 0.0003248/1.524, allocations: 41.88 kB / 1.046 GB, free: 319.7 MB / 0.7481 GB Notification: Performance of postOpt simplifyAllExpressions (simulation): time 0.002/1.526, allocations: 184.8 kB / 1.046 GB, free: 319.7 MB / 0.7481 GB Notification: Performance of postOpt findZeroCrossings (simulation): time 0.0001243/1.527, allocations: 74.52 kB / 1.046 GB, free: 319.7 MB / 0.7481 GB Notification: Performance of postOpt collapseArrayExpressions (simulation): time 0.0001543/1.527, allocations: 64.69 kB / 1.046 GB, free: 319.7 MB / 0.7481 GB Notification: Performance of sorting global known variables: time 0.002483/1.529, allocations: 1.728 MB / 1.048 GB, free: 319 MB / 0.7481 GB Notification: Performance of sort global known variables: time 2.21e-07/1.529, allocations: 0 / 1.048 GB, free: 319 MB / 0.7481 GB Notification: Performance of remove unused functions: time 0.002756/1.532, allocations: 1.284 MB / 1.049 GB, free: 318.9 MB / 0.7481 GB Notification: Model statistics after passing the back-end for simulation: * Number of independent subsystems: 25 * 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 simulation (110): * Single equations (assignments): 106 * Array equations: 0 * Algorithm blocks: 0 * Record equations: 0 * When equations: 0 * If-equations: 0 * Equation systems (not torn): 4 * Torn equation systems: 0 * Mixed (continuous/discrete) equation systems: 0 Notification: Equation system details (not torn): * Constant Jacobian (size): 0 systems * Linear Jacobian (size,density): 0 systems * Non-linear Jacobian (size): 4 systems {1, 1, 1, 1} * Without analytic Jacobian (size): 0 systems Notification: Performance of Backend phase and start with SimCode phase: time 0.0006324/1.533, allocations: 377.3 kB / 1.049 GB, free: 318.8 MB / 0.7481 GB Notification: Performance of simCode: created initialization part: time 0.00707/1.54, allocations: 3.587 MB / 1.053 GB, free: 317.6 MB / 0.7481 GB Notification: Performance of simCode: created event and clocks part: time 1.067e-05/1.54, allocations: 7.203 kB / 1.053 GB, free: 317.6 MB / 0.7481 GB Notification: Performance of simCode: created simulation system equations: time 0.001609/1.541, allocations: 0.8094 MB / 1.054 GB, free: 317.4 MB / 0.7481 GB Notification: Performance of simCode: created of all other equations (e.g. parameter, nominal, assert, etc): time 0.00508/1.546, allocations: 1.198 MB / 1.055 GB, free: 316.9 MB / 0.7481 GB Notification: Performance of simCode: created linear, non-linear and system jacobian parts: time 0.006139/1.553, allocations: 4.244 MB / 1.059 GB, free: 314.4 MB / 0.7481 GB Notification: Performance of simCode: some other stuff during SimCode phase: time 0.0008966/1.554, allocations: 1.7 MB / 1.061 GB, free: 313.3 MB / 0.7481 GB Notification: Performance of simCode: alias equations: time 0.002957/1.556, allocations: 0.7844 MB / 1.061 GB, free: 312.9 MB / 0.7481 GB Notification: Performance of simCode: all other stuff during SimCode phase: time 0.000564/1.557, allocations: 191.4 kB / 1.061 GB, free: 312.8 MB / 0.7481 GB Notification: Performance of SimCode: time 8.72e-07/1.557, allocations: 0 / 1.061 GB, free: 312.8 MB / 0.7481 GB Notification: Performance of Templates: time 0.05889/1.616, allocations: 45.44 MB / 1.106 GB, free: 268 MB / 0.7481 GB make -j1 -f IDEAS_dev_IDEAS.Fluid.Interfaces.Examples.ReverseFlowMassExchanger.makefile (rm -f IDEAS_dev_IDEAS.Fluid.Interfaces.Examples.ReverseFlowMassExchanger.pipe ; mkfifo IDEAS_dev_IDEAS.Fluid.Interfaces.Examples.ReverseFlowMassExchanger.pipe ; head -c 1048576 < IDEAS_dev_IDEAS.Fluid.Interfaces.Examples.ReverseFlowMassExchanger.pipe >> ../files/IDEAS_dev_IDEAS.Fluid.Interfaces.Examples.ReverseFlowMassExchanger.sim & ./IDEAS_dev_IDEAS.Fluid.Interfaces.Examples.ReverseFlowMassExchanger -abortSlowSimulation -alarm=480 -s cvode -lv LOG_STATS > IDEAS_dev_IDEAS.Fluid.Interfaces.Examples.ReverseFlowMassExchanger.pipe 2>&1)