Running: ./testmodel.py --libraries=/home/hudson/saved_omc/libraries/.openmodelica/libraries --ompython_omhome=/usr Pharmacolibrary_Pharmacolibrary.Examples.PK_Caffeine.PK_population_Caffeine.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.001845/0.001845, allocations: 92.83 kB / 20.19 MB, free: 4.336 MB / 18.57 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.001909/0.001909, allocations: 168.9 kB / 23.49 MB, free: 1.031 MB / 18.57 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.475/1.475, allocations: 177.1 MB / 203.8 MB, free: 5.621 MB / 186.7 MB " [Timeout remaining time 178] loadFile("/home/hudson/saved_omc/libraries/.openmodelica/libraries/Pharmacolibrary 25.9.0/package.mo", uses=false) [Timeout 180] "[/home/hudson/saved_omc/libraries/.openmodelica/libraries/Pharmacolibrary 25.9.0/Examples/package.order:0:0-0:0:readonly] Warning: The package.order file does not list all .mo files and directories (containing package.mo) present in its directory. Missing names are: Paracetamol_Experiment Notification: Performance of loadFile(/home/hudson/saved_omc/libraries/.openmodelica/libraries/Pharmacolibrary 25.9.0/package.mo): time 3.305/3.305, allocations: 274.5 MB / 0.5222 GB, free: 14.29 MB / 458.7 MB " [Timeout remaining time 176] Using package Pharmacolibrary with version 25.09 (/home/hudson/saved_omc/libraries/.openmodelica/libraries/Pharmacolibrary 25.9.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(Pharmacolibrary.Examples.PK_Caffeine.PK_population_Caffeine,tolerance=1e-06,outputFormat="empty",numberOfIntervals=500,variableFilter="",fileNamePrefix="Pharmacolibrary_Pharmacolibrary.Examples.PK_Caffeine.PK_population_Caffeine") translateModel(Pharmacolibrary.Examples.PK_Caffeine.PK_population_Caffeine,tolerance=1e-06,outputFormat="empty",numberOfIntervals=500,variableFilter="",fileNamePrefix="Pharmacolibrary_Pharmacolibrary.Examples.PK_Caffeine.PK_population_Caffeine") [Timeout 660] "Notification: Performance of FrontEnd - Absyn->SCode: time 1.389e-05/1.389e-05, allocations: 3.516 kB / 0.6479 GB, free: 39.2 MB / 0.5262 GB Notification: Performance of NFInst.instantiate(Pharmacolibrary.Examples.PK_Caffeine.PK_population_Caffeine): time 0.005588/0.005602, allocations: 6.885 MB / 0.6546 GB, free: 34.67 MB / 0.5262 GB Notification: Performance of NFInst.instExpressions: time 0.00168/0.007282, allocations: 1.297 MB / 0.6559 GB, free: 33.77 MB / 0.5262 GB Notification: Performance of NFInst.updateImplicitVariability: time 0.0002317/0.007514, allocations: 6.75 kB / 0.6559 GB, free: 33.77 MB / 0.5262 GB Notification: Performance of NFTyping.typeComponents: time 0.0002049/0.007719, allocations: 116.8 kB / 0.656 GB, free: 33.7 MB / 0.5262 GB Notification: Performance of NFTyping.typeBindings: time 0.0004925/0.008211, allocations: 342.2 kB / 0.6563 GB, free: 33.45 MB / 0.5262 GB Notification: Performance of NFTyping.typeClassSections: time 0.000484/0.008695, allocations: 290.1 kB / 0.6566 GB, free: 33.26 MB / 0.5262 GB Notification: Performance of NFFlatten.flatten: time 0.00104/0.009735, allocations: 1.375 MB / 0.658 GB, free: 32.52 MB / 0.5262 GB Notification: Performance of NFFlatten.resolveConnections: time 0.0003025/0.01004, allocations: 161.2 kB / 0.6581 GB, free: 32.42 MB / 0.5262 GB Notification: Performance of NFEvalConstants.evaluate: time 0.0005476/0.01058, allocations: 0.6228 MB / 0.6587 GB, free: 32.13 MB / 0.5262 GB Notification: Performance of NFSimplifyModel.simplify: time 0.0004473/0.01103, allocations: 360.5 kB / 0.6591 GB, free: 32 MB / 0.5262 GB Notification: Performance of NFPackage.collectConstants: time 0.0001237/0.01116, allocations: 110.9 kB / 0.6592 GB, free: 32 MB / 0.5262 GB Notification: Performance of NFFlatten.collectFunctions: time 0.0001732/0.01133, allocations: 110.8 kB / 0.6593 GB, free: 32 MB / 0.5262 GB Notification: Performance of combineBinaries: time 0.0008637/0.01219, allocations: 1.471 MB / 0.6607 GB, free: 31.11 MB / 0.5262 GB Notification: Performance of replaceArrayConstructors: time 0.0003602/0.01255, allocations: 0.8125 MB / 0.6615 GB, free: 30.61 MB / 0.5262 GB Notification: Performance of NFVerifyModel.verify: time 0.0001364/0.01269, allocations: 91 kB / 0.6616 GB, free: 30.61 MB / 0.5262 GB Notification: Performance of FrontEnd: time 6.055e-05/0.01275, allocations: 22.16 kB / 0.6616 GB, free: 30.61 MB / 0.5262 GB Notification: Model statistics after passing the front-end and creating the data structures used by the back-end: * Number of equations: 146 (140) * Number of variables: 146 (146) Notification: Performance of [SIM] Bindings: time 0.002492/0.01524, allocations: 3.694 MB / 0.6652 GB, free: 28.07 MB / 0.5262 GB Notification: Performance of [SIM] FunctionAlias: time 0.0003061/0.01555, allocations: 497.6 kB / 0.6657 GB, free: 27.78 MB / 0.5262 GB Notification: Performance of [SIM] Early Inline: time 0.001414/0.01696, allocations: 2.254 MB / 0.6679 GB, free: 26.23 MB / 0.5262 GB Notification: Performance of [SIM] Simplify 1: time 0.0003572/0.01732, allocations: 310.6 kB / 0.6682 GB, free: 26.09 MB / 0.5262 GB Notification: Performance of [SIM] Alias: time 0.002731/0.02005, allocations: 2.745 MB / 0.6709 GB, free: 24.36 MB / 0.5262 GB Notification: Performance of [SIM] Simplify 2: time 0.0002742/0.02032, allocations: 270.8 kB / 0.6711 GB, free: 24.23 MB / 0.5262 GB Notification: Performance of [SIM] Remove Stream: time 0.0001992/0.02052, allocations: 277.5 kB / 0.6714 GB, free: 24.04 MB / 0.5262 GB Notification: Performance of [SIM] Detect States: time 0.0008893/0.02141, allocations: 0.9755 MB / 0.6723 GB, free: 23.36 MB / 0.5262 GB Notification: Performance of [SIM] Events: time 0.0003902/0.0218, allocations: 402.4 kB / 0.6727 GB, free: 23.17 MB / 0.5262 GB Notification: Performance of [SIM] Partitioning: time 0.0009916/0.02279, allocations: 1.009 MB / 0.6737 GB, free: 22.54 MB / 0.5262 GB Notification: Performance of [SIM] Causalize: time 0.002978/0.02577, allocations: 2.62 MB / 0.6763 GB, free: 21.17 MB / 0.5262 GB Notification: Performance of [SIM] After Index Reduction Inline: time 0.001344/0.02712, allocations: 1.85 MB / 0.6781 GB, free: 19.96 MB / 0.5262 GB Notification: Performance of [INI] Simplify: time 0.001614/0.02873, allocations: 1.239 MB / 0.6793 GB, free: 19.27 MB / 0.5262 GB Notification: Performance of [INI] Inline: time 0.001931/0.03066, allocations: 2.724 MB / 0.682 GB, free: 17.46 MB / 0.5262 GB Notification: Performance of [INI] Partitioning: time 0.0001192/0.03078, allocations: 69.97 kB / 0.682 GB, free: 17.42 MB / 0.5262 GB Notification: Performance of [INI] Cleanup: time 0.0004454/0.03123, allocations: 0.6356 MB / 0.6826 GB, free: 16.96 MB / 0.5262 GB Error: Internal error NBResolveSingularities.balanceInitialization failed because following non-fixable variables could not be solved: [DISC] (1) discrete Real green_tee_drinker.periodicDose.absorptionLumen.Cmin (min = -1e-9) [DISC] (1) discrete Real green_tee_drinker.periodicDose.absorptionLumen.Cmax (min = -1e-9) [DISC] (1) discrete Real green_tee_drinker.central.Cmin (min = -1e-9) [DISC] (1) discrete Real green_tee_drinker.central.Cmax (min = -1e-9) [DISC] (1) discrete Real black_tea_drinker.periodicDose.absorptionLumen.Cmin (min = -1e-9) [DISC] (1) discrete Real black_tea_drinker.periodicDose.absorptionLumen.Cmax (min = -1e-9) [DISC] (1) discrete Real black_tea_drinker.central.Cmin (min = -1e-9) [DISC] (1) discrete Real black_tea_drinker.central.Cmax (min = -1e-9) [DISC] (1) discrete Real coffee_drinker.periodicDose.absorptionLumen.Cmin (min = -1e-9) [DISC] (1) discrete Real coffee_drinker.periodicDose.absorptionLumen.Cmax (min = -1e-9) [DISC] (1) discrete Real coffee_drinker.central.Cmin (min = -1e-9) [DISC] (1) discrete Real coffee_drinker.central.Cmax (min = -1e-9) Following equations were created by fixing variables: [SCAL] (1) $PRE.coffee_drinker.central.rising = $START.coffee_drinker.central.rising; ($RES_SRT_312) [SCAL] (1) $PRE.coffee_drinker.periodicDose.absorptionLumen.rising = $START.coffee_drinker.periodicDose.absorptionLumen.rising; ($RES_SRT_311) [SCAL] (1) $PRE.black_tea_drinker.central.rising = $START.black_tea_drinker.central.rising; ($RES_SRT_310) [SCAL] (1) $PRE.black_tea_drinker.periodicDose.absorptionLumen.rising = $START.black_tea_drinker.periodicDose.absorptionLumen.rising; ($RES_SRT_309) [SCAL] (1) $PRE.green_tee_drinker.central.rising = $START.green_tee_drinker.central.rising; ($RES_SRT_308) [SCAL] (1) $PRE.green_tee_drinker.periodicDose.absorptionLumen.rising = $START.green_tee_drinker.periodicDose.absorptionLumen.rising; ($RES_SRT_307) [SCAL] (1) green_tee_drinker.periodicDose.variableDose.TotalCumulativeMass = $START.green_tee_drinker.periodicDose.variableDose.TotalCumulativeMass; ($RES_SRT_306) [SCAL] (1) green_tee_drinker.periodicDose.absorptionLumen.AUC = $START.green_tee_drinker.periodicDose.absorptionLumen.AUC; ($RES_SRT_305) [SCAL] (1) green_tee_drinker.periodicDose.TotalCumulativeMass = $START.green_tee_drinker.periodicDose.TotalCumulativeMass; ($RES_SRT_304) [SCAL] (1) green_tee_drinker.central.AUC = $START.green_tee_drinker.central.AUC; ($RES_SRT_303) [SCAL] (1) black_tea_drinker.periodicDose.variableDose.TotalCumulativeMass = $START.black_tea_drinker.periodicDose.variableDose.TotalCumulativeMass; ($RES_SRT_302) [SCAL] (1) black_tea_drinker.periodicDose.absorptionLumen.AUC = $START.black_tea_drinker.periodicDose.absorptionLumen.AUC; ($RES_SRT_301) [SCAL] (1) black_tea_drinker.periodicDose.TotalCumulativeMass = $START.black_tea_drinker.periodicDose.TotalCumulativeMass; ($RES_SRT_300) [SCAL] (1) black_tea_drinker.central.AUC = $START.black_tea_drinker.central.AUC; ($RES_SRT_299) [SCAL] (1) coffee_drinker.periodicDose.variableDose.TotalCumulativeMass = $START.coffee_drinker.periodicDose.variableDose.TotalCumulativeMass; ($RES_SRT_298) [SCAL] (1) coffee_drinker.periodicDose.absorptionLumen.AUC = $START.coffee_drinker.periodicDose.absorptionLumen.AUC; ($RES_SRT_297) [SCAL] (1) coffee_drinker.periodicDose.TotalCumulativeMass = $START.coffee_drinker.periodicDose.TotalCumulativeMass; ($RES_SRT_296) [SCAL] (1) coffee_drinker.central.AUC = $START.coffee_drinker.central.AUC; ($RES_SRT_295) Use -d=bltdump for more verbose debug output. Error: Internal error NBInitialization.main failed to apply modules! " [Timeout remaining time 660] [Calling sys.exit(0), Time elapsed: 5.794321655994281]