Running: ./testmodel.py --libraries=/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/ --ompython_omhome=/usr ModelicaTest_3.2.1_ModelicaTest.Tables.CombiTable2D.Test9.conf.json Using package ModelicaTest with version 3.2.1 (/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaTest 3.2.1+maint.om/package.mo) Using package ModelicaServices with version 3.2.1 (/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 3.2.1+maint.om/package.mo) Using package Modelica with version 3.2.1 (/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 3.2.1+maint.om/package.mo) Using package Complex with version 3.2.1 (/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 3.2.1+maint.om/package.mo) Running command: translateModel(ModelicaTest.Tables.CombiTable2D.Test9,tolerance=1e-06,outputFormat="mat",numberOfIntervals=5000,variableFilter="time|t_new.y|clock1.y|clock2.y",fileNamePrefix="ModelicaTest_3.2.1_ModelicaTest.Tables.CombiTable2D.Test9") Notification: Performance of loadFile(/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 3.2.1+maint.om/package.mo): time 0.004201/0.004208, allocations: 348.4 kB / 15.94 MB, free: 6.215 MB / 13.93 MB Notification: Performance of loadFile(/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 3.2.1+maint.om/package.mo): time 3.821/3.821, allocations: 341.5 MB / 358.2 MB, free: 12.57 MB / 298.7 MB Notification: Performance of loadFile(/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 3.2.1+maint.om/package.mo): time 0.003434/0.003434, allocations: 217.2 kB / 397.9 MB, free: 4.91 MB / 330.7 MB Notification: Performance of loadFile(/var/lib/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaTest 3.2.1+maint.om/package.mo): time 0.5675/0.5675, allocations: 76.09 MB / 0.5014 GB, free: 112.6 MB / 362.7 MB Notification: Performance of FrontEnd - loaded program: time 0.0004633/0.0004636, allocations: 16 kB / 0.5592 GB, free: 53.45 MB / 362.7 MB Notification: Performance of FrontEnd - Absyn->SCode: time 0.104/0.1045, allocations: 48.7 MB / 0.6067 GB, free: 4.637 MB / 362.7 MB Notification: Performance of NFInst.instantiate(ModelicaTest.Tables.CombiTable2D.Test9): time 0.002703/0.1072, allocations: 1.192 MB / 0.6079 GB, free: 3.434 MB / 362.7 MB Notification: Performance of NFInst.instExpressions: time 0.0009176/0.1082, allocations: 251.9 kB / 0.6081 GB, free: 3.184 MB / 362.7 MB Notification: Performance of NFInst.updateImplicitVariability: time 7.332e-05/0.1083, allocations: 0 / 0.6081 GB, free: 3.184 MB / 362.7 MB Notification: Performance of NFTyping.typeComponents: time 0.0008598/0.1092, allocations: 435.2 kB / 0.6086 GB, free: 2.758 MB / 362.7 MB Notification: Performance of NFTyping.typeBindings: time 0.0005319/0.1098, allocations: 235.6 kB / 0.6088 GB, free: 2.527 MB / 362.7 MB Notification: Performance of NFTyping.typeClassSections: time 0.0002201/0.11, allocations: 27.91 kB / 0.6088 GB, free: 2.5 MB / 362.7 MB Notification: Performance of NFFlatten.flatten: time 0.0002674/0.1103, allocations: 123.7 kB / 0.6089 GB, free: 2.379 MB / 362.7 MB Notification: Performance of NFFlatten.resolveConnections: time 0.0001153/0.1105, allocations: 8 kB / 0.6089 GB, free: 2.371 MB / 362.7 MB Notification: Performance of NFEvalConstants.evaluate: time 0.0001689/0.1107, allocations: 99.78 kB / 0.609 GB, free: 2.273 MB / 362.7 MB Notification: Performance of NFSimplifyModel.simplify: time 0.0003226/0.111, allocations: 171.7 kB / 0.6092 GB, free: 2.105 MB / 362.7 MB Notification: Performance of NFPackage.collectConstants: time 3.494e-05/0.1111, allocations: 4 kB / 0.6092 GB, free: 2.102 MB / 362.7 MB Notification: Performance of NFFlatten.collectFunctions: time 0.0001119/0.1112, allocations: 8 kB / 0.6092 GB, free: 2.094 MB / 362.7 MB Notification: Performance of NFScalarize.scalarize: time 0.0001238/0.1113, allocations: 75.75 kB / 0.6093 GB, free: 2.02 MB / 362.7 MB Notification: Performance of NFVerifyModel.verify: time 7.329e-05/0.1114, allocations: 65.52 kB / 0.6093 GB, free: 1.949 MB / 362.7 MB Notification: Performance of NFConvertDAE.convert: time 0.0003322/0.1118, allocations: 159.8 kB / 0.6095 GB, free: 1.793 MB / 362.7 MB Notification: Performance of FrontEnd - DAE generated: time 8.145e-06/0.1118, allocations: 0 / 0.6095 GB, free: 1.793 MB / 362.7 MB Notification: Performance of FrontEnd: time 2.755e-06/0.1118, allocations: 0 / 0.6095 GB, free: 1.793 MB / 362.7 MB Notification: Performance of Transformations before backend: time 8.145e-06/0.1119, allocations: 0 / 0.6095 GB, free: 1.793 MB / 362.7 MB Notification: Model statistics after passing the front-end and creating the data structures used by the back-end: * Number of equations: 5 * Number of variables: 5 Notification: Performance of Generate backend data structure: time 0.001155/0.113, allocations: 0.6124 MB / 0.6101 GB, free: 1.125 MB / 362.7 MB Notification: Performance of prepare preOptimizeDAE: time 6.817e-05/0.1131, allocations: 8.031 kB / 0.6101 GB, free: 1.117 MB / 362.7 MB Notification: Performance of preOpt normalInlineFunction (simulation): time 0.0001054/0.1133, allocations: 51.33 kB / 0.6101 GB, free: 1.066 MB / 362.7 MB Notification: Performance of preOpt evaluateParameters (simulation): time 0.2991/0.4124, allocations: 262.8 kB / 0.6104 GB, free: 90.79 MB / 362.7 MB Notification: Performance of preOpt simplifyIfEquations (simulation): time 2.049e-05/0.4125, allocations: 0.9062 kB / 0.6104 GB, free: 90.79 MB / 362.7 MB Notification: Performance of preOpt expandDerOperator (simulation): time 2.718e-05/0.4125, allocations: 4.531 kB / 0.6104 GB, free: 90.79 MB / 362.7 MB Notification: Performance of preOpt clockPartitioning (simulation): time 0.0003728/0.4129, allocations: 56.36 kB / 0.6105 GB, free: 90.76 MB / 362.7 MB Notification: Performance of preOpt findStateOrder (simulation): time 1.894e-05/0.413, allocations: 5.484 kB / 0.6105 GB, free: 90.76 MB / 362.7 MB Notification: Performance of preOpt replaceEdgeChange (simulation): time 1.431e-05/0.413, allocations: 0.5625 kB / 0.6105 GB, free: 90.76 MB / 362.7 MB Notification: Performance of preOpt inlineArrayEqn (simulation): time 7.624e-06/0.413, allocations: 1.531 kB / 0.6105 GB, free: 90.76 MB / 362.7 MB Notification: Performance of preOpt removeEqualRHS (simulation): time 0.0003593/0.4134, allocations: 39.73 kB / 0.6105 GB, free: 90.76 MB / 362.7 MB Notification: Performance of preOpt removeSimpleEquations (simulation): time 0.0008048/0.4142, allocations: 376.3 kB / 0.6109 GB, free: 90.5 MB / 362.7 MB Notification: Performance of preOpt comSubExp (simulation): time 0.0002811/0.4146, allocations: 46.86 kB / 0.6109 GB, free: 90.47 MB / 362.7 MB Notification: Performance of preOpt resolveLoops (simulation): time 0.0001646/0.4148, allocations: 27.38 kB / 0.6109 GB, free: 90.46 MB / 362.7 MB Notification: Performance of preOpt evalFunc (simulation): time 3.285e-05/0.4148, allocations: 1.375 kB / 0.6109 GB, free: 90.46 MB / 362.7 MB Notification: Performance of preOpt encapsulateWhenConditions (simulation): time 3.652e-05/0.4149, allocations: 32.03 kB / 0.611 GB, free: 90.43 MB / 362.7 MB Notification: Performance of pre-optimization done (n=3): time 5.1e-06/0.4149, allocations: 0 / 0.611 GB, free: 90.43 MB / 362.7 MB Notification: Performance of matching and sorting (n=3): time 0.0007467/0.4157, allocations: 136.3 kB / 0.6111 GB, free: 90.38 MB / 362.7 MB Notification: Performance of inlineWhenForInitialization (initialization): time 2.791e-05/0.4157, allocations: 53 kB / 0.6111 GB, free: 90.32 MB / 362.7 MB Notification: Performance of selectInitializationVariablesDAE (initialization): time 0.001948/0.4177, allocations: 0.8411 MB / 0.612 GB, free: 90.21 MB / 362.7 MB Notification: Performance of collectPreVariables (initialization): time 3.584e-05/0.4178, allocations: 26.27 kB / 0.612 GB, free: 90.18 MB / 362.7 MB Notification: Performance of collectInitialEqns (initialization): time 0.0003522/0.4182, allocations: 220.7 kB / 0.6122 GB, free: 90.09 MB / 362.7 MB Notification: Performance of collectInitialBindings (initialization): time 4.156e-05/0.4182, allocations: 7.984 kB / 0.6122 GB, free: 90.09 MB / 362.7 MB Notification: Performance of simplifyInitialFunctions (initialization): time 8.476e-06/0.4183, allocations: 0 / 0.6122 GB, free: 90.09 MB / 362.7 MB Notification: Performance of setup shared object (initialization): time 0.0001824/0.4185, allocations: 363.5 kB / 0.6126 GB, free: 89.77 MB / 362.7 MB Notification: Performance of preBalanceInitialSystem (initialization): time 0.0004269/0.4189, allocations: 23.47 kB / 0.6126 GB, free: 89.77 MB / 362.7 MB Notification: Performance of partitionIndependentBlocks (initialization): time 0.0003458/0.4193, allocations: 21.14 kB / 0.6126 GB, free: 89.77 MB / 362.7 MB Notification: Performance of analyzeInitialSystem (initialization): time 0.0003333/0.4197, allocations: 47.55 kB / 0.6126 GB, free: 89.74 MB / 362.7 MB Notification: Performance of solveInitialSystemEqSystem (initialization): time 7.494e-06/0.4197, allocations: 2.875 kB / 0.6126 GB, free: 89.74 MB / 362.7 MB Notification: Performance of matching and sorting (n=4) (initialization): time 0.0007935/0.4206, allocations: 137.5 kB / 0.6128 GB, free: 89.66 MB / 362.7 MB Notification: Performance of prepare postOptimizeDAE: time 9.369e-05/0.4207, allocations: 34.59 kB / 0.6128 GB, free: 89.62 MB / 362.7 MB Notification: Performance of postOpt simplifyComplexFunction (initialization): time 1.619e-05/0.4207, allocations: 3.375 kB / 0.6128 GB, free: 89.62 MB / 362.7 MB Notification: Performance of postOpt tearingSystem (initialization): time 3.198e-05/0.4208, allocations: 0 / 0.6128 GB, free: 89.62 MB / 362.7 MB Notification: Performance of postOpt solveSimpleEquations (initialization): time 0.0003588/0.4212, allocations: 11.62 kB / 0.6128 GB, free: 89.62 MB / 362.7 MB Notification: Performance of postOpt calculateStrongComponentJacobians (initialization): time 1.434e-05/0.4212, allocations: 5.875 kB / 0.6128 GB, free: 89.62 MB / 362.7 MB Notification: Performance of postOpt simplifyAllExpressions (initialization): time 0.0004464/0.4217, allocations: 15.34 kB / 0.6128 GB, free: 89.62 MB / 362.7 MB Notification: Performance of postOpt collapseArrayExpressions (initialization): time 3.198e-05/0.4218, allocations: 0.9688 kB / 0.6128 GB, free: 89.62 MB / 362.7 MB Notification: Model statistics after passing the back-end for initialization: * Number of independent subsystems: 1 * 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 (4): * Single equations (assignments): 3 * 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.0005371/0.4224, allocations: 216.8 kB / 0.6131 GB, free: 89.5 MB / 362.7 MB Notification: Performance of postOpt lateInlineFunction (simulation): time 0.0001435/0.4225, allocations: 37.59 kB / 0.6131 GB, free: 89.48 MB / 362.7 MB Notification: Performance of postOpt wrapFunctionCalls (simulation): time 0.0004936/0.423, allocations: 121.1 kB / 0.6132 GB, free: 89.44 MB / 362.7 MB Notification: Performance of postOpt simplifysemiLinear (simulation): time 6.041e-06/0.4231, allocations: 4.438 kB / 0.6132 GB, free: 89.44 MB / 362.7 MB Notification: Performance of postOpt simplifyComplexFunction (simulation): time 3.577e-06/0.4231, allocations: 0 / 0.6132 GB, free: 89.44 MB / 362.7 MB Notification: Performance of postOpt removeConstants (simulation): time 8.74e-05/0.4232, allocations: 107 kB / 0.6133 GB, free: 89.33 MB / 362.7 MB Notification: Performance of postOpt simplifyTimeIndepFuncCalls (simulation): time 4.054e-05/0.4232, allocations: 1.375 kB / 0.6133 GB, free: 89.33 MB / 362.7 MB Notification: Performance of postOpt simplifyAllExpressions (simulation): time 0.000156/0.4234, allocations: 6.719 kB / 0.6133 GB, free: 89.33 MB / 362.7 MB Notification: Performance of postOpt findZeroCrossings (simulation): time 4.893e-05/0.4235, allocations: 11.53 kB / 0.6133 GB, free: 89.32 MB / 362.7 MB Notification: Performance of postOpt createDAEmodeBDAE (simulation): time 0.000353/0.4238, allocations: 157.9 kB / 0.6135 GB, free: 89.22 MB / 362.7 MB Notification: Performance of postOpt detectDAEmodeSparsePattern (simulation): time 0.0003759/0.4242, allocations: 282.4 kB / 0.6137 GB, free: 88.99 MB / 362.7 MB Notification: Performance of postOpt setEvaluationStage (simulation): time 0.0001343/0.4244, allocations: 27.14 kB / 0.6138 GB, free: 88.99 MB / 362.7 MB Notification: Performance of sorting global known variables: time 0.001129/0.4255, allocations: 0.6401 MB / 0.6144 GB, free: 88.91 MB / 362.7 MB Notification: Performance of Backend: time 1.623e-06/0.4256, allocations: 1.156 kB / 0.6144 GB, free: 88.91 MB / 362.7 MB Notification: Performance of simCode: created initialization part: time 0.001304/0.4269, allocations: 369.7 kB / 0.6148 GB, free: 88.78 MB / 362.7 MB Notification: Performance of SimCode: time 0.001674/0.4286, allocations: 1.131 MB / 0.6159 GB, free: 88.01 MB / 362.7 MB Notification: Performance of Templates: time 0.006951/0.4356, allocations: 1.047 MB / 0.6169 GB, free: 88.01 MB / 362.7 MB "" Variables in the reference:time,t_new.y,clock1.y,clock2.y Variables in the result:clock1.offset,clock1.startTime,clock1.y,clock2.offset,clock2.startTime,clock2.y,t_new.smoothness,t_new.tableOnFile,t_new.tableOnFileRead,t_new.table[1,10],t_new.table[1,1],t_new.table[1,2],t_new.table[1,3],t_new.table[1,4],t_new.table[1,5],t_new.table[1,6],t_new.table[1,7],t_new.table[1,8],t_new.table[1,9],t_new.table[10,10],t_new.table[10,1],t_new.table[10,2],t_new.table[10,3],t_new.table[10,4],t_new.table[10,5],t_new.table[10,6],t_new.table[10,7],t_new.table[10,8],t_new.table[10,9],t_new.table[11,10],t_new.table[11,1],t_new.table[11,2],t_new.table[11,3],t_new.table[11,4],t_new.table[11,5],t_new.table[11,6],t_new.table[11,7],t_new.table[11,8],t_new.table[11,9],t_new.table[12,10],t_new.table[12,1],t_new.table[12,2],t_new.table[12,3],t_new.table[12,4],t_new.table[12,5],t_new.table[12,6],t_new.table[12,7],t_new.table[12,8],t_new.table[12,9],t_new.table[2,10],t_new.table[2,1],t_new.table[2,2],t_new.table[2,3],t_new.table[2,4],t_new.table[2,5],t_new.table[2,6],t_new.table[2,7],t_new.table[2,8],t_new.table[2,9],t_new.table[3,10],t_new.table[3,1],t_new.table[3,2],t_new.table[3,3],t_new.table[3,4],t_new.table[3,5],t_new.table[3,6],t_new.table[3,7],t_new.table[3,8],t_new.table[3,9],t_new.table[4,10],t_new.table[4,1],t_new.table[4,2],t_new.table[4,3],t_new.table[4,4],t_new.table[4,5],t_new.table[4,6],t_new.table[4,7],t_new.table[4,8],t_new.table[4,9],t_new.table[5,10],t_new.table[5,1],t_new.table[5,2],t_new.table[5,3],t_new.table[5,4],t_new.table[5,5],t_new.table[5,6],t_new.table[5,7],t_new.table[5,8],t_new.table[5,9],t_new.table[6,10],t_new.table[6,1],t_new.table[6,2],t_new.table[6,3],t_new.table[6,4],t_new.table[6,5],t_new.table[6,6],t_new.table[6,7],t_new.table[6,8],t_new.table[6,9],t_new.table[7,10],t_new.table[7,1],t_new.table[7,2],t_new.table[7,3],t_new.table[7,4],t_new.table[7,5],t_new.table[7,6],t_new.table[7,7],t_new.table[7,8],t_new.table[7,9],t_new.table[8,10],t_new.table[8,1],t_new.table[8,2],t_new.table[8,3],t_new.table[8,4],t_new.table[8,5],t_new.table[8,6],t_new.table[8,7],t_new.table[8,8],t_new.table[8,9],t_new.table[9,10],t_new.table[9,1],t_new.table[9,2],t_new.table[9,3],t_new.table[9,4],t_new.table[9,5],t_new.table[9,6],t_new.table[9,7],t_new.table[9,8],t_new.table[9,9],t_new.verboseRead,t_new.y,time