Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries --ompython_omhome=/usr Chemical_Chemical.Obsolete.Examples.CheckSubstancesData.SimpleReaction2.conf.json loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.1.0+maint.om/package.mo", uses=false) [Timeout 180] "Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.1.0+maint.om/package.mo): time 0.001486/0.001486, allocations: 104.3 kB / 19.77 MB, free: 2.051 MB / 14.72 MB " [Timeout remaining time 180] loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 4.1.0+maint.om/package.mo", uses=false) [Timeout 180] "Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 4.1.0+maint.om/package.mo): time 0.001602/0.001602, allocations: 213.5 kB / 23.07 MB, free: 4.844 MB / 14.72 MB " [Timeout remaining time 180] loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.1.0+maint.om/package.mo", uses=false) [Timeout 180] "Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.1.0+maint.om/package.mo): time 1.305/1.305, allocations: 230.7 MB / 256.9 MB, free: 7.773 MB / 206.1 MB " [Timeout remaining time 179] loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical 2.0.0/package.mo", uses=false) [Timeout 180] "Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical 2.0.0/package.mo): time 0.1224/0.1224, allocations: 23.88 MB / 337.2 MB, free: 10.95 MB / 270.1 MB " [Timeout remaining time 180] Using package Chemical with version 2.0.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical 2.0.0/package.mo) Using package Modelica with version 4.1.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Modelica 4.1.0+maint.om/package.mo) Using package Complex with version 4.1.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Complex 4.1.0+maint.om/package.mo) Using package ModelicaServices with version 4.1.0 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/ModelicaServices 4.1.0+maint.om/package.mo) Running command: translateModel(Chemical.Obsolete.Examples.CheckSubstancesData.SimpleReaction2,tolerance=1e-06,outputFormat="empty",numberOfIntervals=2500,variableFilter="",fileNamePrefix="Chemical_Chemical.Obsolete.Examples.CheckSubstancesData.SimpleReaction2") translateModel(Chemical.Obsolete.Examples.CheckSubstancesData.SimpleReaction2,tolerance=1e-06,outputFormat="empty",numberOfIntervals=2500,variableFilter="",fileNamePrefix="Chemical_Chemical.Obsolete.Examples.CheckSubstancesData.SimpleReaction2") [Timeout 660] "Notification: Performance of FrontEnd - Absyn->SCode: time 1.611e-05/1.611e-05, allocations: 2.281 kB / 472.4 MB, free: 7.027 MB / 334.1 MB [/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical 2.0.0/Obsolete.mo:12638:6-12638:65:writable] Warning: An inner declaration for outer component system could not be found and was automatically generated. [/home/hudson/saved_omc/libraries/.openmodelica/libraries/Chemical 2.0.0/Obsolete.mo:12638:6-12638:65:writable] Notification: The diagnostics message for the missing inner is: Your model is using an outer \"system\" component but an inner \"system\" component is not defined. For simulation drag Modelica.Fluid.System into your model to specify system properties. Notification: Performance of NFInst.instantiate(Chemical.Obsolete.Examples.CheckSubstancesData.SimpleReaction2): time 0.06637/0.06638, allocations: 24.15 MB / 496.6 MB, free: 15.01 MB / 366.1 MB Notification: Performance of NFInst.instExpressions: time 0.01008/0.07646, allocations: 8.078 MB / 0.4928 GB, free: 6.902 MB / 366.1 MB Notification: Performance of NFInst.updateImplicitVariability: time 0.0002848/0.07675, allocations: 15.81 kB / 0.4928 GB, free: 6.887 MB / 366.1 MB Notification: Performance of NFTyping.typeComponents: time 0.0005456/0.0773, allocations: 202.5 kB / 0.493 GB, free: 6.688 MB / 366.1 MB Notification: Performance of NFTyping.typeBindings: time 0.0007616/0.07806, allocations: 353.3 kB / 0.4934 GB, free: 6.34 MB / 366.1 MB Notification: Performance of NFTyping.typeClassSections: time 0.002853/0.08091, allocations: 1.448 MB / 0.4948 GB, free: 4.883 MB / 366.1 MB Notification: Performance of NFFlatten.flatten: time 0.0007588/0.08167, allocations: 0.7206 MB / 0.4955 GB, free: 4.156 MB / 366.1 MB Notification: Performance of NFFlatten.resolveConnections: time 0.0003117/0.08198, allocations: 193 kB / 0.4957 GB, free: 3.961 MB / 366.1 MB Notification: Performance of NFEvalConstants.evaluate: time 0.0004367/0.08242, allocations: 374.9 kB / 0.496 GB, free: 3.594 MB / 366.1 MB Notification: Performance of NFSimplifyModel.simplify: time 0.0004571/0.08287, allocations: 342.8 kB / 0.4964 GB, free: 3.258 MB / 366.1 MB Notification: Performance of NFPackage.collectConstants: time 7.66e-05/0.08295, allocations: 36 kB / 0.4964 GB, free: 3.223 MB / 366.1 MB Notification: Performance of NFFlatten.collectFunctions: time 0.001403/0.08435, allocations: 0.7799 MB / 0.4972 GB, free: 2.441 MB / 366.1 MB Notification: Performance of combineBinaries: time 0.000869/0.08522, allocations: 0.9982 MB / 0.4981 GB, free: 1.434 MB / 366.1 MB Notification: Performance of replaceArrayConstructors: time 0.0004315/0.08565, allocations: 0.6209 MB / 0.4987 GB, free: 0.8047 MB / 366.1 MB Notification: Performance of NFVerifyModel.verify: time 6.899e-05/0.08572, allocations: 44 kB / 0.4988 GB, free: 0.7617 MB / 366.1 MB Notification: Performance of FrontEnd: time 9.11e-05/0.08581, allocations: 39.89 kB / 0.4988 GB, free: 0.7227 MB / 366.1 MB Notification: Model statistics after passing the front-end and creating the data structures used by the back-end: * Number of equations: 76 (74) * Number of variables: 76 (73) Notification: Performance of [SIM] Bindings: time 0.002457/0.08827, allocations: 2.614 MB / 0.5014 GB, free: 13.96 MB / 382.1 MB Notification: Performance of [SIM] FunctionAlias: time 0.0005398/0.08881, allocations: 451.5 kB / 0.5018 GB, free: 13.49 MB / 382.1 MB Notification: Performance of [SIM] Early Inline: time 0.002914/0.09172, allocations: 2.386 MB / 0.5041 GB, free: 11.09 MB / 382.1 MB Notification: Performance of [SIM] Simplify 1: time 0.0003254/0.09205, allocations: 220.3 kB / 0.5043 GB, free: 10.82 MB / 382.1 MB Notification: Performance of [SIM] Alias: time 0.002064/0.09411, allocations: 1.654 MB / 0.506 GB, free: 8.777 MB / 382.1 MB Notification: Performance of [SIM] Simplify 2: time 0.0002222/0.09434, allocations: 166.2 kB / 0.5061 GB, free: 8.562 MB / 382.1 MB Notification: Performance of [SIM] Remove Stream: time 9.354e-05/0.09443, allocations: 88.31 kB / 0.5062 GB, free: 8.449 MB / 382.1 MB Notification: Performance of [SIM] Detect States: time 0.0001972/0.09463, allocations: 195.1 kB / 0.5064 GB, free: 8.207 MB / 382.1 MB Notification: Performance of [SIM] Events: time 5.606e-05/0.09468, allocations: 43.91 kB / 0.5064 GB, free: 8.164 MB / 382.1 MB Notification: Performance of [SIM] Partitioning: time 0.0004634/0.09515, allocations: 445.8 kB / 0.5069 GB, free: 7.598 MB / 382.1 MB Notification: Performance of [SIM] Causalize: time 0.0008683/0.09601, allocations: 0.6769 MB / 0.5075 GB, free: 6.793 MB / 382.1 MB Notification: Performance of [SIM] After Index Reduction Inline: time 0.0003985/0.09641, allocations: 443.6 kB / 0.5079 GB, free: 6.359 MB / 382.1 MB Notification: Performance of [INI] Simplify: time 0.0007299/0.09714, allocations: 0.5607 MB / 0.5085 GB, free: 5.727 MB / 382.1 MB Notification: Performance of [INI] Inline: time 0.0008492/0.09799, allocations: 0.898 MB / 0.5094 GB, free: 4.828 MB / 382.1 MB Notification: Performance of [INI] Partitioning: time 5.07e-05/0.09804, allocations: 33.36 kB / 0.5094 GB, free: 4.785 MB / 382.1 MB Notification: Performance of [INI] Cleanup: time 0.0001283/0.09817, allocations: 139.8 kB / 0.5095 GB, free: 4.648 MB / 382.1 MB Notification: Performance of [INI] Causalize: time 0.001226/0.0994, allocations: 0.9491 MB / 0.5105 GB, free: 3.691 MB / 382.1 MB Notification: Performance of [INI] Tearing: time 2.857e-05/0.09943, allocations: 36 kB / 0.5105 GB, free: 3.656 MB / 382.1 MB Notification: Performance of [SIM] Initialization: time 4.01e-07/0.09943, allocations: 0 / 0.5105 GB, free: 3.656 MB / 382.1 MB Notification: Performance of [SIM] DAE-Mode: time 0.0004481/0.09987, allocations: 381.5 kB / 0.5109 GB, free: 3.156 MB / 382.1 MB Notification: Performance of [SIM] Remove Dummies: time 8.356e-06/0.09988, allocations: 7.938 kB / 0.5109 GB, free: 3.148 MB / 382.1 MB Notification: Performance of [SIM] Tearing: time 2.769e-05/0.09991, allocations: 43.94 kB / 0.5109 GB, free: 3.105 MB / 382.1 MB Notification: Performance of [SIM] Categorize: time 1.821e-05/0.09993, allocations: 11.94 kB / 0.5109 GB, free: 3.094 MB / 382.1 MB Notification: Performance of [SIM] Solve: time 0.001071/0.101, allocations: 0.8257 MB / 0.5117 GB, free: 2.266 MB / 382.1 MB Error: Internal error NBJacobian.SparsityColoring.PartialD2ColoringAlgC.getIndices failed because cref reaction.substrates[2].u is neither a seed nor a partial candidate! " [Timeout remaining time 660] [Calling sys.exit(0), Time elapsed: 2.441105990030337] Failed to read output from testmodel.py, exit status != 0: 0.10834848700324073 0.270685971 0.182432575 Calling exit ...