2019-12-03 13:43:08.17535416.0MbinfoCronjob execution started. PID: 17244
2019-12-03 13:43:08.18106716.0MbinforesetOnFirstRun was set, reset BSP settlement data
2019-12-03 13:43:08.28554616.0MbsuccessCleared previous matches
2019-12-03 13:43:08.37385516.0MbinfoFound 126,449 BSP records
2019-12-03 13:43:08.42470616.0MbinfoResume from bsp record 0
2019-12-03 13:51:52.78996638.0MbwaitingSystem busy. Load: 3.92, expected:3.5. Sleeping 11s
2019-12-03 13:52:06.82426138.0MbwaitingSystem busy. Load: 4.62, expected:3.5. Sleeping 21s
2019-12-03 13:52:27.83416738.0MbwaitingSystem busy. Load: 4.46, expected:3.5. Sleeping 11s
2019-12-03 13:52:38.84330838.0MbwaitingSystem busy. Load: 3.85, expected:3.5. Sleeping 11s
2019-12-03 13:55:08.51330740.0MbsuccessScanned all BSP records. It took 720.2s
2019-12-03 13:55:09.05862340.0MbinfoFound 0 ImportedOrders services
2019-12-03 13:55:09.05886540.0MbwarningNo pre-parsed importedServices records found. The reported progress will not be accurate
2019-12-03 13:55:09.46350040.0Mbinfo > scan systems: amadeus, galileo, sabre, worldspan, manual
2019-12-03 13:55:09.46370940.0Mbinfo > scan services: k, x
2019-12-03 13:55:09.46466840.0MbinfoResume from imported service 0
2019-12-03 13:55:09.46486740.0Mbinfo > ignoring 0 suppliers
2019-12-03 13:55:09.64743740.0MbinfoScanned 0 imported services, and ignored 0 services
2019-12-03 13:55:09.64882440.0MbsuccessScanned all imported services. It took 1.1s
2019-12-03 13:55:09.67436940.0MbinfoFound 0 BSP settlement records unmatched. Compare them now
2019-12-03 13:55:11.22033940.0MbsuccessScanned all ImportedOrder services. It took 1.6s
2019-12-03 13:55:11.22049840.0MbinfoAll done
2019-12-03 13:55:11.22058240.0MbinfoInserted 102,962 rows
2019-12-03 13:55:11.22066340.0MbinfoUpdated 102,962 rows
2019-12-03 13:55:11.22074140.0MbinfoRe-checked 23,487 rows
2019-12-03 13:55:11.22082240.0MbinfoDone 28 queue flushes, processed 317.3 rps (estimated)
2019-12-03 13:55:11.22362240.0MbinfoCronjob execution ended.