2023-06-25T16:13:04.334Z,1687709584.334 [DataOverHttps](INFO): Received command: restart logs
2023-06-25T16:13:04.344Z,1687709584.344 [CommandExec](IMPORTANT): got command restart logs
2023-06-25T16:15:00.075Z,1687709700.075 [CommandExec](FAULT): Schedule is paused. Ignoring time-scheduled command: maintain clear
2023-06-25T16:17:27.392Z,1687709847.392 [NAL9602](FAULT): MT Queue status failed to be acquired within timeout. Will not retry this session.
2023-06-25T16:17:53.658Z,1687709873.658 [Default:CheckIn:C.Wait](INFO): Done Waiting.
2023-06-25T16:17:53.658Z,1687709873.658 [Default:CheckIn:C.Wait] Stopped
2023-06-25T16:17:53.658Z,1687709873.658 [Default:CheckIn:C.Wait](DEBUG): Uninitialize Wait Component.
2023-06-25T16:17:53.659Z,1687709873.659 [Default:CheckIn:D] Running Loop=1
2023-06-25T16:17:54.073Z,1687709874.073 [Default:CheckIn:D] Stopped
2023-06-25T16:17:54.073Z,1687709874.073 [Default:CheckIn:E] Running Loop=1
2023-06-25T16:17:54.464Z,1687709874.464 [Default:CheckIn:E](IMPORTANT): Default mission has been running for 16.486582 min 
2023-06-25T16:17:54.464Z,1687709874.464 [Default:CheckIn:E] Stopped
2023-06-25T16:17:54.465Z,1687709874.465 [Default:CheckIn](INFO): Completed Default:CheckIn
2023-06-25T16:17:54.465Z,1687709874.465 [Default:CheckIn] Stopped
2023-06-25T16:17:54.465Z,1687709874.465 [Default:CheckIn](DEBUG): Aggregate::uninitialize Default:CheckIn
2023-06-25T16:17:54.465Z,1687709874.465 [Default:CheckIn](INFO): Running loop #3
2023-06-25T16:17:54.465Z,1687709874.465 [Default:CheckIn] Running Loop=3
2023-06-25T16:17:54.465Z,1687709874.465 [Default:CheckIn](DEBUG): Aggregate::initialize Default:CheckIn
2023-06-25T16:17:54.465Z,1687709874.465 [Default:CheckIn:Read_GPS] Running Loop=1
2023-06-25T16:17:56.477Z,1687709876.477 [NAL9602](DEBUG): Parsing RMC sentence: $GPRMC,161755.00,A,4313.34735,N,08620.15576,W,0.039,156.64,250623,,,D*7D
2023-06-25T16:17:56.479Z,1687709876.479 [NAL9602](INFO): GPS fix at 20230625T161755: (43.222456, -86.335929)
2023-06-25T16:17:56.489Z,1687709876.489 [Default:CheckIn:Read_GPS] Stopped
2023-06-25T16:17:56.489Z,1687709876.489 [Default:CheckIn:Read_Iridium] Running Loop=1
2023-06-25T16:18:06.022Z,1687709886.022 [DataOverHttps](INFO): Sending 39 bytes from file Logs/20230625T145119/Courier0040.lzma
2023-06-25T16:18:07.024Z,1687709887.024 [DataOverHttps](INFO): Moved sent file to Logs/20230625T145119/Courier0040.lzma.bak
2023-06-25T16:18:07.025Z,1687709887.025 [DataOverHttps](INFO): SBD MOMSN=18428028
2023-06-25T16:18:22.622Z,1687709902.622 [DataOverHttps](INFO): Sending 266 bytes from file Logs/20230625T161304/Courier0000.lzma
2023-06-25T16:18:23.624Z,1687709903.624 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Courier0000.lzma.bak
2023-06-25T16:18:23.624Z,1687709903.624 [DataOverHttps](INFO): SBD MOMSN=18428030
2023-06-25T16:18:28.420Z,1687709908.420 [NAL9602](INFO): Not Powering down - fast GPS
2023-06-25T16:18:39.198Z,1687709919.198 [DataOverHttps](INFO): Sending 115 bytes from file Logs/20230625T145119/Express0041.lzma
2023-06-25T16:18:41.204Z,1687709921.204 [DataOverHttps](INFO): Moved sent file to Logs/20230625T145119/Express0041.lzma.bak
2023-06-25T16:18:41.204Z,1687709921.204 [DataOverHttps](INFO): SBD MOMSN=18428034
2023-06-25T16:18:56.803Z,1687709936.803 [DataOverHttps](INFO): Sending 514 bytes from file Logs/20230625T161304/Express0001.lzma
2023-06-25T16:18:57.804Z,1687709937.804 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Express0001.lzma.bak
2023-06-25T16:18:57.804Z,1687709937.804 [DataOverHttps](INFO): SBD MOMSN=18428037
2023-06-25T16:19:19.398Z,1687709959.398 [DataOverHttps](INFO): Sending 61 bytes from file Logs/20230625T161304/Express0004.lzma
2023-06-25T16:19:20.400Z,1687709960.400 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Express0004.lzma.bak
2023-06-25T16:19:20.400Z,1687709960.400 [DataOverHttps](INFO): SBD MOMSN=18428043
2023-06-25T16:19:22.326Z,1687709962.326 [Default:CheckIn:Read_Iridium] Stopped
2023-06-25T16:19:22.327Z,1687709962.327 [Default:CheckIn:C.Wait] Running Loop=1
2023-06-25T16:19:22.327Z,1687709962.327 [Default:CheckIn:C.Wait](DEBUG): Initialize Wait Component.
2023-06-25T16:24:22.884Z,1687710262.884 [Default:CheckIn:C.Wait](INFO): Done Waiting.
2023-06-25T16:24:22.884Z,1687710262.884 [Default:CheckIn:C.Wait] Stopped
2023-06-25T16:24:22.884Z,1687710262.884 [Default:CheckIn:C.Wait](DEBUG): Uninitialize Wait Component.
2023-06-25T16:24:22.884Z,1687710262.884 [Default:CheckIn:D] Running Loop=1
2023-06-25T16:24:23.301Z,1687710263.301 [Default:CheckIn:D] Stopped
2023-06-25T16:24:23.301Z,1687710263.301 [Default:CheckIn:E] Running Loop=1
2023-06-25T16:24:23.693Z,1687710263.693 [Default:CheckIn:E](IMPORTANT): Default mission has been running for 22.973728 min 
2023-06-25T16:24:23.693Z,1687710263.693 [Default:CheckIn:E] Stopped
2023-06-25T16:24:23.693Z,1687710263.693 [Default:CheckIn](INFO): Completed Default:CheckIn
2023-06-25T16:24:23.693Z,1687710263.693 [Default:CheckIn] Stopped
2023-06-25T16:24:23.693Z,1687710263.693 [Default:CheckIn](DEBUG): Aggregate::uninitialize Default:CheckIn
2023-06-25T16:24:23.693Z,1687710263.693 [Default:CheckIn](INFO): Running loop #4
2023-06-25T16:24:23.693Z,1687710263.693 [Default:CheckIn] Running Loop=4
2023-06-25T16:24:23.693Z,1687710263.693 [Default:CheckIn](DEBUG): Aggregate::initialize Default:CheckIn
2023-06-25T16:24:23.693Z,1687710263.693 [Default:CheckIn:Read_GPS] Running Loop=1
2023-06-25T16:24:25.709Z,1687710265.709 [NAL9602](DEBUG): Parsing RMC sentence: $GPRMC,162424.00,A,4313.42762,N,08620.13590,W,3.285,319.32,250623,,,D*7A
2023-06-25T16:24:25.712Z,1687710265.712 [NAL9602](INFO): GPS fix at 20230625T162424: (43.223794, -86.335598)
2023-06-25T16:24:25.721Z,1687710265.721 [Default:CheckIn:Read_GPS] Stopped
2023-06-25T16:24:25.722Z,1687710265.722 [Default:CheckIn:Read_Iridium] Running Loop=1
2023-06-25T16:24:36.310Z,1687710276.310 [DataOverHttps](INFO): Sending 72 bytes from file Logs/20230625T161304/Courier0006.lzma
2023-06-25T16:24:37.312Z,1687710277.312 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Courier0006.lzma.bak
2023-06-25T16:24:37.312Z,1687710277.312 [DataOverHttps](INFO): SBD MOMSN=18428045
2023-06-25T16:24:56.468Z,1687710296.468 [NAL9602](ERROR): Failed to receive proper response when querying signal strength for MT queue check.
2023-06-25T16:24:56.542Z,1687710296.542 [NAL9602](ERROR): received: 
+CSQ:0

OK
2023-06-25T16:24:57.154Z,1687710297.154 [DataOverHttps](INFO): Sending 144 bytes from file Logs/20230625T161304/Express0007.lzma
2023-06-25T16:24:58.156Z,1687710298.156 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Express0007.lzma.bak
2023-06-25T16:24:58.156Z,1687710298.156 [DataOverHttps](INFO): SBD MOMSN=18428048
2023-06-25T16:24:59.729Z,1687710299.729 [Default:CheckIn:Read_Iridium] Stopped
2023-06-25T16:24:59.729Z,1687710299.729 [Default:CheckIn:C.Wait] Running Loop=1
2023-06-25T16:24:59.729Z,1687710299.729 [Default:CheckIn:C.Wait](DEBUG): Initialize Wait Component.
2023-06-25T16:26:52.621Z,1687710412.621 [CBIT](IMPORTANT): Beginning ground fault scan
2023-06-25T16:26:55.407Z,1687710415.407 [CBIT](ERROR): Error reading 24V bus power status. Assuming off for scan purposes.
2023-06-25T16:27:03.499Z,1687710423.499 [CBIT](IMPORTANT): Ground fault detected
mA:
CHAN A0 (Batt): 0.370519
CHAN A1 (24V) N/A reporting off
CHAN A2 (12V): 0.349998
CHAN A3 (5V): 0.135576
CHAN B0 (3.3V): 0.099686
CHAN B1 (3.15aV): 0.102327
CHAN B2 (3.15bV): 0.098826
CHAN B3 (GND): 0.008384
OPEN: 0.015665
Full Scale: +/- 1 mA
2023-06-25T16:29:28.460Z,1687710568.460 [NAL9602](FAULT): MT Queue status failed to be acquired within timeout. Will not retry this session.
2023-06-25T16:29:59.164Z,1687710599.164 [NAL9602](INFO): Not Powering down - fast GPS
2023-06-25T16:30:00.389Z,1687710600.389 [Default:CheckIn:C.Wait](INFO): Done Waiting.
2023-06-25T16:30:00.389Z,1687710600.389 [Default:CheckIn:C.Wait] Stopped
2023-06-25T16:30:00.389Z,1687710600.389 [Default:CheckIn:C.Wait](DEBUG): Uninitialize Wait Component.
2023-06-25T16:30:00.390Z,1687710600.390 [Default:CheckIn:D] Running Loop=1
2023-06-25T16:30:00.793Z,1687710600.793 [Default:CheckIn:D] Stopped
2023-06-25T16:30:00.793Z,1687710600.793 [Default:CheckIn:E] Running Loop=1
2023-06-25T16:30:01.193Z,1687710601.193 [Default:CheckIn:E](IMPORTANT): Default mission has been running for 28.598588 min 
2023-06-25T16:30:01.194Z,1687710601.194 [Default:CheckIn:E] Stopped
2023-06-25T16:30:01.194Z,1687710601.194 [Default:CheckIn](INFO): Completed Default:CheckIn
2023-06-25T16:30:01.194Z,1687710601.194 [Default:CheckIn] Stopped
2023-06-25T16:30:01.194Z,1687710601.194 [Default:CheckIn](DEBUG): Aggregate::uninitialize Default:CheckIn
2023-06-25T16:30:01.194Z,1687710601.194 [Default:CheckIn](INFO): Running loop #5
2023-06-25T16:30:01.194Z,1687710601.194 [Default:CheckIn] Running Loop=5
2023-06-25T16:30:01.194Z,1687710601.194 [Default:CheckIn](DEBUG): Aggregate::initialize Default:CheckIn
2023-06-25T16:30:01.195Z,1687710601.195 [Default:CheckIn:Read_GPS] Running Loop=1
2023-06-25T16:30:03.209Z,1687710603.209 [NAL9602](DEBUG): Parsing RMC sentence: $GPRMC,163002.00,A,4313.61546,N,08620.32477,W,0.117,318.72,250623,,,D*7B
2023-06-25T16:30:03.212Z,1687710603.212 [NAL9602](INFO): GPS fix at 20230625T163002: (43.226924, -86.338746)
2023-06-25T16:30:03.241Z,1687710603.241 [Default:CheckIn:Read_GPS] Stopped
2023-06-25T16:30:03.242Z,1687710603.242 [Default:CheckIn:Read_Iridium] Running Loop=1
2023-06-25T16:30:10.138Z,1687710610.138 [DataOverHttps](INFO): Sending 73 bytes from file Logs/20230625T161304/Courier0009.lzma
2023-06-25T16:30:11.140Z,1687710611.140 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Courier0009.lzma.bak
2023-06-25T16:30:11.140Z,1687710611.140 [DataOverHttps](INFO): SBD MOMSN=18428051
2023-06-25T16:30:26.979Z,1687710626.979 [DataOverHttps](INFO): Sending 429 bytes from file Logs/20230625T161304/Express0010.lzma
2023-06-25T16:30:27.980Z,1687710627.980 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Express0010.lzma.bak
2023-06-25T16:30:27.980Z,1687710627.980 [DataOverHttps](INFO): SBD MOMSN=18428054
2023-06-25T16:30:29.558Z,1687710629.558 [Default:CheckIn:Read_Iridium] Stopped
2023-06-25T16:30:29.558Z,1687710629.558 [Default:CheckIn:C.Wait] Running Loop=1
2023-06-25T16:30:29.558Z,1687710629.558 [Default:CheckIn:C.Wait](DEBUG): Initialize Wait Component.
2023-06-25T16:30:33.984Z,1687710633.984 [NAL9602](ERROR): Failed to receive proper response when querying signal strength for MT queue check.
2023-06-25T16:30:34.058Z,1687710634.058 [NAL9602](ERROR): received: 
+CSQ:0

OK
2023-06-25T16:35:05.504Z,1687710905.504 [NAL9602](FAULT): MT Queue status failed to be acquired within timeout. Will not retry this session.
2023-06-25T16:35:30.161Z,1687710930.161 [Default:CheckIn:C.Wait](INFO): Done Waiting.
2023-06-25T16:35:30.161Z,1687710930.161 [Default:CheckIn:C.Wait] Stopped
2023-06-25T16:35:30.161Z,1687710930.161 [Default:CheckIn:C.Wait](DEBUG): Uninitialize Wait Component.
2023-06-25T16:35:30.162Z,1687710930.162 [Default:CheckIn:D] Running Loop=1
2023-06-25T16:35:30.578Z,1687710930.578 [Default:CheckIn:D] Stopped
2023-06-25T16:35:30.578Z,1687710930.578 [Default:CheckIn:E] Running Loop=1
2023-06-25T16:35:30.969Z,1687710930.969 [Default:CheckIn:E](IMPORTANT): Default mission has been running for 34.095001 min 
2023-06-25T16:35:30.969Z,1687710930.969 [Default:CheckIn:E] Stopped
2023-06-25T16:35:30.970Z,1687710930.970 [Default:CheckIn](INFO): Completed Default:CheckIn
2023-06-25T16:35:30.970Z,1687710930.970 [Default:CheckIn] Stopped
2023-06-25T16:35:30.970Z,1687710930.970 [Default:CheckIn](DEBUG): Aggregate::uninitialize Default:CheckIn
2023-06-25T16:35:30.970Z,1687710930.970 [Default:CheckIn](INFO): Running loop #6
2023-06-25T16:35:30.970Z,1687710930.970 [Default:CheckIn] Running Loop=6
2023-06-25T16:35:30.970Z,1687710930.970 [Default:CheckIn](DEBUG): Aggregate::initialize Default:CheckIn
2023-06-25T16:35:30.970Z,1687710930.970 [Default:CheckIn:Read_GPS] Running Loop=1
2023-06-25T16:35:32.976Z,1687710932.976 [NAL9602](DEBUG): Parsing RMC sentence: $GPRMC,163532.00,A,4313.61245,N,08620.32720,W,0.544,318.72,250623,,,A*7F
2023-06-25T16:35:32.979Z,1687710932.979 [NAL9602](INFO): GPS fix at 20230625T163532: (43.226874, -86.338787)
2023-06-25T16:35:32.989Z,1687710932.989 [Default:CheckIn:Read_GPS] Stopped
2023-06-25T16:35:32.989Z,1687710932.989 [Default:CheckIn:Read_Iridium] Running Loop=1
2023-06-25T16:35:39.746Z,1687710939.746 [DataOverHttps](INFO): Sending 72 bytes from file Logs/20230625T161304/Courier0012.lzma
2023-06-25T16:35:41.598Z,1687710941.598 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Courier0012.lzma.bak
2023-06-25T16:35:41.598Z,1687710941.598 [DataOverHttps](INFO): SBD MOMSN=18428060
2023-06-25T16:35:56.434Z,1687710956.434 [DataOverHttps](INFO): Sending 203 bytes from file Logs/20230625T161304/Express0013.lzma
2023-06-25T16:35:57.436Z,1687710957.436 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Express0013.lzma.bak
2023-06-25T16:35:57.436Z,1687710957.436 [DataOverHttps](INFO): SBD MOMSN=18428063
2023-06-25T16:35:59.301Z,1687710959.301 [Default:CheckIn:Read_Iridium] Stopped
2023-06-25T16:35:59.301Z,1687710959.301 [Default:CheckIn:C.Wait] Running Loop=1
2023-06-25T16:35:59.302Z,1687710959.302 [Default:CheckIn:C.Wait](DEBUG): Initialize Wait Component.
2023-06-25T16:36:05.344Z,1687710965.344 [NAL9602](INFO): Not Powering down - fast GPS
2023-06-25T16:40:59.873Z,1687711259.873 [Default:CheckIn:C.Wait](INFO): Done Waiting.
2023-06-25T16:40:59.873Z,1687711259.873 [Default:CheckIn:C.Wait] Stopped
2023-06-25T16:40:59.873Z,1687711259.873 [Default:CheckIn:C.Wait](DEBUG): Uninitialize Wait Component.
2023-06-25T16:40:59.874Z,1687711259.874 [Default:CheckIn:D] Running Loop=1
2023-06-25T16:41:00.270Z,1687711260.270 [Default:CheckIn:D] Stopped
2023-06-25T16:41:00.270Z,1687711260.270 [Default:CheckIn:E] Running Loop=1
2023-06-25T16:41:00.685Z,1687711260.685 [Default:CheckIn:E](IMPORTANT): Default mission has been running for 39.589876 min 
2023-06-25T16:41:00.685Z,1687711260.685 [Default:CheckIn:E] Stopped
2023-06-25T16:41:00.685Z,1687711260.685 [Default:CheckIn](INFO): Completed Default:CheckIn
2023-06-25T16:41:00.685Z,1687711260.685 [Default:CheckIn] Stopped
2023-06-25T16:41:00.686Z,1687711260.686 [Default:CheckIn](DEBUG): Aggregate::uninitialize Default:CheckIn
2023-06-25T16:41:00.686Z,1687711260.686 [Default:CheckIn](INFO): Running loop #7
2023-06-25T16:41:00.686Z,1687711260.686 [Default:CheckIn] Running Loop=7
2023-06-25T16:41:00.686Z,1687711260.686 [Default:CheckIn](DEBUG): Aggregate::initialize Default:CheckIn
2023-06-25T16:41:00.686Z,1687711260.686 [Default:CheckIn:Read_GPS] Running Loop=1
2023-06-25T16:41:02.685Z,1687711262.685 [NAL9602](DEBUG): Parsing RMC sentence: $GPRMC,164101.00,A,4313.62077,N,08620.29383,W,2.138,213.67,250623,,,A*78
2023-06-25T16:41:02.688Z,1687711262.688 [NAL9602](INFO): GPS fix at 20230625T164101: (43.227013, -86.338230)
2023-06-25T16:41:02.735Z,1687711262.735 [Default:CheckIn:Read_GPS] Stopped
2023-06-25T16:41:02.735Z,1687711262.735 [Default:CheckIn:Read_Iridium] Running Loop=1
2023-06-25T16:41:12.894Z,1687711272.894 [DataOverHttps](INFO): Sending 72 bytes from file Logs/20230625T161304/Courier0015.lzma
2023-06-25T16:41:13.896Z,1687711273.896 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Courier0015.lzma.bak
2023-06-25T16:41:13.896Z,1687711273.896 [DataOverHttps](INFO): SBD MOMSN=18428067
2023-06-25T16:41:30.598Z,1687711290.598 [DataOverHttps](INFO): Sending 139 bytes from file Logs/20230625T161304/Express0016.lzma
2023-06-25T16:41:31.601Z,1687711291.601 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Express0016.lzma.bak
2023-06-25T16:41:31.601Z,1687711291.601 [DataOverHttps](INFO): SBD MOMSN=18428070
2023-06-25T16:41:33.440Z,1687711293.440 [NAL9602](ERROR): Failed to receive proper response when querying signal strength for MT queue check.
2023-06-25T16:41:33.518Z,1687711293.518 [NAL9602](ERROR): received: 
+CSQ:0

OK
2023-06-25T16:41:33.547Z,1687711293.547 [Default:CheckIn:Read_Iridium] Stopped
2023-06-25T16:41:33.547Z,1687711293.547 [Default:CheckIn:C.Wait] Running Loop=1
2023-06-25T16:41:33.547Z,1687711293.547 [Default:CheckIn:C.Wait](DEBUG): Initialize Wait Component.
2023-06-25T16:46:05.404Z,1687711565.404 [NAL9602](FAULT): MT Queue status failed to be acquired within timeout. Will not retry this session.
2023-06-25T16:46:34.096Z,1687711594.096 [Default:CheckIn:C.Wait](INFO): Done Waiting.
2023-06-25T16:46:34.096Z,1687711594.096 [Default:CheckIn:C.Wait] Stopped
2023-06-25T16:46:34.096Z,1687711594.096 [Default:CheckIn:C.Wait](DEBUG): Uninitialize Wait Component.
2023-06-25T16:46:34.096Z,1687711594.096 [Default:CheckIn:D] Running Loop=1
2023-06-25T16:46:34.510Z,1687711594.510 [Default:CheckIn:D] Stopped
2023-06-25T16:46:34.510Z,1687711594.510 [Default:CheckIn:E] Running Loop=1
2023-06-25T16:46:34.904Z,1687711594.904 [Default:CheckIn:E](IMPORTANT): Default mission has been running for 45.160543 min 
2023-06-25T16:46:34.904Z,1687711594.904 [Default:CheckIn:E] Stopped
2023-06-25T16:46:34.904Z,1687711594.904 [Default:CheckIn](INFO): Completed Default:CheckIn
2023-06-25T16:46:34.905Z,1687711594.905 [Default:CheckIn] Stopped
2023-06-25T16:46:34.905Z,1687711594.905 [Default:CheckIn](DEBUG): Aggregate::uninitialize Default:CheckIn
2023-06-25T16:46:34.905Z,1687711594.905 [Default:CheckIn](INFO): Running loop #8
2023-06-25T16:46:34.905Z,1687711594.905 [Default:CheckIn] Running Loop=8
2023-06-25T16:46:34.905Z,1687711594.905 [Default:CheckIn](DEBUG): Aggregate::initialize Default:CheckIn
2023-06-25T16:46:34.905Z,1687711594.905 [Default:CheckIn:Read_GPS] Running Loop=1
2023-06-25T16:46:36.921Z,1687711596.921 [NAL9602](DEBUG): Parsing RMC sentence: $GPRMC,164636.00,A,4313.61108,N,08620.31331,W,0.583,316.61,250623,,,A*75
2023-06-25T16:46:36.923Z,1687711596.923 [NAL9602](INFO): GPS fix at 20230625T164636: (43.226851, -86.338555)
2023-06-25T16:46:36.933Z,1687711596.933 [Default:CheckIn:Read_GPS] Stopped
2023-06-25T16:46:36.934Z,1687711596.934 [Default:CheckIn:Read_Iridium] Running Loop=1
2023-06-25T16:46:43.854Z,1687711603.854 [DataOverHttps](INFO): Sending 72 bytes from file Logs/20230625T161304/Courier0018.lzma
2023-06-25T16:46:44.856Z,1687711604.856 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Courier0018.lzma.bak
2023-06-25T16:46:44.856Z,1687711604.856 [DataOverHttps](INFO): SBD MOMSN=18428073
2023-06-25T16:47:03.287Z,1687711623.287 [DataOverHttps](INFO): Sending 215 bytes from file Logs/20230625T161304/Express0019.lzma
2023-06-25T16:47:04.288Z,1687711624.288 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Express0019.lzma.bak
2023-06-25T16:47:04.288Z,1687711624.288 [DataOverHttps](INFO): SBD MOMSN=18428076
2023-06-25T16:47:06.509Z,1687711626.509 [Default:CheckIn:Read_Iridium] Stopped
2023-06-25T16:47:06.510Z,1687711626.510 [Default:CheckIn:C.Wait] Running Loop=1
2023-06-25T16:47:06.510Z,1687711626.510 [Default:CheckIn:C.Wait](DEBUG): Initialize Wait Component.
2023-06-25T16:47:09.731Z,1687711629.731 [NAL9602](INFO): Not Powering down - fast GPS
2023-06-25T16:52:07.230Z,1687711927.230 [Default:CheckIn:C.Wait](INFO): Done Waiting.
2023-06-25T16:52:07.230Z,1687711927.230 [Default:CheckIn:C.Wait] Stopped
2023-06-25T16:52:07.230Z,1687711927.230 [Default:CheckIn:C.Wait](DEBUG): Uninitialize Wait Component.
2023-06-25T16:52:07.230Z,1687711927.230 [Default:CheckIn:D] Running Loop=1
2023-06-25T16:52:07.629Z,1687711927.629 [Default:CheckIn:D] Stopped
2023-06-25T16:52:07.629Z,1687711927.629 [Default:CheckIn:E] Running Loop=1
2023-06-25T16:52:08.033Z,1687711928.033 [Default:CheckIn:E](IMPORTANT): Default mission has been running for 50.712528 min 
2023-06-25T16:52:08.033Z,1687711928.033 [Default:CheckIn:E] Stopped
2023-06-25T16:52:08.033Z,1687711928.033 [Default:CheckIn](INFO): Completed Default:CheckIn
2023-06-25T16:52:08.033Z,1687711928.033 [Default:CheckIn] Stopped
2023-06-25T16:52:08.033Z,1687711928.033 [Default:CheckIn](DEBUG): Aggregate::uninitialize Default:CheckIn
2023-06-25T16:52:08.034Z,1687711928.034 [Default:CheckIn](INFO): Running loop #9
2023-06-25T16:52:08.034Z,1687711928.034 [Default:CheckIn] Running Loop=9
2023-06-25T16:52:08.034Z,1687711928.034 [Default:CheckIn](DEBUG): Aggregate::initialize Default:CheckIn
2023-06-25T16:52:08.034Z,1687711928.034 [Default:CheckIn:Read_GPS] Running Loop=1
2023-06-25T16:52:10.041Z,1687711930.041 [NAL9602](DEBUG): Parsing RMC sentence: $GPRMC,165209.00,A,4313.62898,N,08620.32957,W,1.458,316.61,250623,,,A*70
2023-06-25T16:52:10.054Z,1687711930.054 [NAL9602](INFO): GPS fix at 20230625T165209: (43.227150, -86.338826)
2023-06-25T16:52:10.064Z,1687711930.064 [Default:CheckIn:Read_GPS] Stopped
2023-06-25T16:52:10.064Z,1687711930.064 [Default:CheckIn:Read_Iridium] Running Loop=1
2023-06-25T16:52:17.382Z,1687711937.382 [DataOverHttps](INFO): Sending 73 bytes from file Logs/20230625T161304/Courier0021.lzma
2023-06-25T16:52:18.384Z,1687711938.384 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Courier0021.lzma.bak
2023-06-25T16:52:18.384Z,1687711938.384 [DataOverHttps](INFO): SBD MOMSN=18428081
2023-06-25T16:52:33.982Z,1687711953.982 [DataOverHttps](INFO): Sending 143 bytes from file Logs/20230625T161304/Express0022.lzma
2023-06-25T16:52:34.984Z,1687711954.984 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Express0022.lzma.bak
2023-06-25T16:52:34.984Z,1687711954.984 [DataOverHttps](INFO): SBD MOMSN=18428084
2023-06-25T16:52:36.725Z,1687711956.725 [Default:CheckIn:Read_Iridium] Stopped
2023-06-25T16:52:36.725Z,1687711956.725 [Default:CheckIn:C.Wait] Running Loop=1
2023-06-25T16:52:36.725Z,1687711956.725 [Default:CheckIn:C.Wait](DEBUG): Initialize Wait Component.
2023-06-25T16:52:40.744Z,1687711960.744 [NAL9602](ERROR): Failed to receive proper response when querying signal strength for MT queue check.
2023-06-25T16:52:40.818Z,1687711960.818 [NAL9602](ERROR): received: 
+CSQ:0

OK
2023-06-25T16:57:12.404Z,1687712232.404 [NAL9602](FAULT): MT Queue status failed to be acquired within timeout. Will not retry this session.
2023-06-25T16:57:37.457Z,1687712257.457 [Default:CheckIn:C.Wait](INFO): Done Waiting.
2023-06-25T16:57:37.457Z,1687712257.457 [Default:CheckIn:C.Wait] Stopped
2023-06-25T16:57:37.457Z,1687712257.457 [Default:CheckIn:C.Wait](DEBUG): Uninitialize Wait Component.
2023-06-25T16:57:37.458Z,1687712257.458 [Default:CheckIn:D] Running Loop=1
2023-06-25T16:57:37.873Z,1687712257.873 [Default:CheckIn:D] Stopped
2023-06-25T16:57:37.873Z,1687712257.873 [Default:CheckIn:E] Running Loop=1
2023-06-25T16:57:38.269Z,1687712258.269 [Default:CheckIn:E](IMPORTANT): Default mission has been running for 56.216597 min 
2023-06-25T16:57:38.269Z,1687712258.269 [Default:CheckIn:E] Stopped
2023-06-25T16:57:38.269Z,1687712258.269 [Default:CheckIn](INFO): Completed Default:CheckIn
2023-06-25T16:57:38.269Z,1687712258.269 [Default:CheckIn] Stopped
2023-06-25T16:57:38.269Z,1687712258.269 [Default:CheckIn](DEBUG): Aggregate::uninitialize Default:CheckIn
2023-06-25T16:57:38.270Z,1687712258.270 [Default:CheckIn](INFO): Running loop #10
2023-06-25T16:57:38.270Z,1687712258.270 [Default:CheckIn] Running Loop=10
2023-06-25T16:57:38.270Z,1687712258.270 [Default:CheckIn](DEBUG): Aggregate::initialize Default:CheckIn
2023-06-25T16:57:38.270Z,1687712258.270 [Default:CheckIn:Read_GPS] Running Loop=1
2023-06-25T16:57:40.276Z,1687712260.276 [NAL9602](DEBUG): Parsing RMC sentence: $GPRMC,165739.00,A,4313.61360,N,08620.30911,W,0.603,316.61,250623,,,A*74
2023-06-25T16:57:40.279Z,1687712260.279 [NAL9602](INFO): GPS fix at 20230625T165739: (43.226893, -86.338485)
2023-06-25T16:57:40.289Z,1687712260.289 [Default:CheckIn:Read_GPS] Stopped
2023-06-25T16:57:40.289Z,1687712260.289 [Default:CheckIn:Read_Iridium] Running Loop=1
2023-06-25T16:57:47.314Z,1687712267.314 [DataOverHttps](INFO): Sending 73 bytes from file Logs/20230625T161304/Courier0024.lzma
2023-06-25T16:57:48.316Z,1687712268.316 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Courier0024.lzma.bak
2023-06-25T16:57:48.316Z,1687712268.316 [DataOverHttps](INFO): SBD MOMSN=18428087
2023-06-25T16:58:03.858Z,1687712283.858 [DataOverHttps](INFO): Sending 217 bytes from file Logs/20230625T161304/Express0025.lzma
2023-06-25T16:58:04.860Z,1687712284.860 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Express0025.lzma.bak
2023-06-25T16:58:04.860Z,1687712284.860 [DataOverHttps](INFO): SBD MOMSN=18428090
2023-06-25T16:58:06.550Z,1687712286.550 [Default:CheckIn:Read_Iridium] Stopped
2023-06-25T16:58:06.551Z,1687712286.551 [Default:CheckIn:C.Wait] Running Loop=1
2023-06-25T16:58:06.551Z,1687712286.551 [Default:CheckIn:C.Wait](DEBUG): Initialize Wait Component.
2023-06-25T16:58:12.599Z,1687712292.599 [NAL9602](INFO): Not Powering down - fast GPS
2023-06-25T17:03:07.235Z,1687712587.235 [Default:CheckIn:C.Wait](INFO): Done Waiting.
2023-06-25T17:03:07.235Z,1687712587.235 [Default:CheckIn:C.Wait] Stopped
2023-06-25T17:03:07.235Z,1687712587.235 [Default:CheckIn:C.Wait](DEBUG): Uninitialize Wait Component.
2023-06-25T17:03:07.235Z,1687712587.235 [Default:CheckIn:D] Running Loop=1
2023-06-25T17:03:07.629Z,1687712587.629 [Default:CheckIn:D] Stopped
2023-06-25T17:03:07.629Z,1687712587.629 [Default:CheckIn:E] Running Loop=1
2023-06-25T17:03:08.043Z,1687712588.043 [Default:CheckIn:E](IMPORTANT): Default mission has been running for 61.712520 min 
2023-06-25T17:03:08.043Z,1687712588.043 [Default:CheckIn:E] Stopped
2023-06-25T17:03:08.043Z,1687712588.043 [Default:CheckIn](INFO): Completed Default:CheckIn
2023-06-25T17:03:08.043Z,1687712588.043 [Default:CheckIn] Stopped
2023-06-25T17:03:08.043Z,1687712588.043 [Default:CheckIn](DEBUG): Aggregate::uninitialize Default:CheckIn
2023-06-25T17:03:08.044Z,1687712588.044 [Default:CheckIn](INFO): Running loop #11
2023-06-25T17:03:08.044Z,1687712588.044 [Default:CheckIn] Running Loop=11
2023-06-25T17:03:08.044Z,1687712588.044 [Default:CheckIn](DEBUG): Aggregate::initialize Default:CheckIn
2023-06-25T17:03:08.044Z,1687712588.044 [Default:CheckIn:Read_GPS] Running Loop=1
2023-06-25T17:03:10.045Z,1687712590.045 [NAL9602](DEBUG): Parsing RMC sentence: $GPRMC,170309.00,A,4313.63042,N,08620.32173,W,0.194,0.00,250623,,,A*72
2023-06-25T17:03:10.047Z,1687712590.047 [NAL9602](INFO): GPS fix at 20230625T170309: (43.227174, -86.338696)
2023-06-25T17:03:10.094Z,1687712590.094 [Default:CheckIn:Read_GPS] Stopped
2023-06-25T17:03:10.094Z,1687712590.094 [Default:CheckIn:Read_Iridium] Running Loop=1
2023-06-25T17:03:17.550Z,1687712597.550 [DataOverHttps](INFO): Sending 72 bytes from file Logs/20230625T161304/Courier0027.lzma
2023-06-25T17:03:18.552Z,1687712598.552 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Courier0027.lzma.bak
2023-06-25T17:03:18.552Z,1687712598.552 [DataOverHttps](INFO): SBD MOMSN=18428094
2023-06-25T17:03:34.186Z,1687712614.186 [DataOverHttps](INFO): Sending 141 bytes from file Logs/20230625T161304/Express0028.lzma
2023-06-25T17:03:35.188Z,1687712615.188 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Express0028.lzma.bak
2023-06-25T17:03:35.188Z,1687712615.188 [DataOverHttps](INFO): SBD MOMSN=18428097
2023-06-25T17:03:36.727Z,1687712616.727 [Default:CheckIn:Read_Iridium] Stopped
2023-06-25T17:03:36.727Z,1687712616.727 [Default:CheckIn:C.Wait] Running Loop=1
2023-06-25T17:03:36.727Z,1687712616.727 [Default:CheckIn:C.Wait](DEBUG): Initialize Wait Component.
2023-06-25T17:03:40.756Z,1687712620.756 [NAL9602](ERROR): Failed to receive proper response when querying signal strength for MT queue check.
2023-06-25T17:03:40.839Z,1687712620.839 [NAL9602](ERROR): received: 
+CSQ:0

OK
2023-06-25T17:08:12.288Z,1687712892.288 [NAL9602](FAULT): MT Queue status failed to be acquired within timeout. Will not retry this session.
2023-06-25T17:08:37.345Z,1687712917.345 [Default:CheckIn:C.Wait](INFO): Done Waiting.
2023-06-25T17:08:37.345Z,1687712917.345 [Default:CheckIn:C.Wait] Stopped
2023-06-25T17:08:37.345Z,1687712917.345 [Default:CheckIn:C.Wait](DEBUG): Uninitialize Wait Component.
2023-06-25T17:08:37.346Z,1687712917.346 [Default:CheckIn:D] Running Loop=1
2023-06-25T17:08:37.741Z,1687712917.741 [Default:CheckIn:D] Stopped
2023-06-25T17:08:37.741Z,1687712917.741 [Default:CheckIn:E] Running Loop=1
2023-06-25T17:08:38.144Z,1687712918.144 [Default:CheckIn:E](IMPORTANT): Default mission has been running for 67.214388 min 
2023-06-25T17:08:38.145Z,1687712918.145 [Default:CheckIn:E] Stopped
2023-06-25T17:08:38.145Z,1687712918.145 [Default:CheckIn](INFO): Completed Default:CheckIn
2023-06-25T17:08:38.145Z,1687712918.145 [Default:CheckIn] Stopped
2023-06-25T17:08:38.145Z,1687712918.145 [Default:CheckIn](DEBUG): Aggregate::uninitialize Default:CheckIn
2023-06-25T17:08:38.145Z,1687712918.145 [Default:CheckIn](INFO): Running loop #12
2023-06-25T17:08:38.145Z,1687712918.145 [Default:CheckIn] Running Loop=12
2023-06-25T17:08:38.145Z,1687712918.145 [Default:CheckIn](DEBUG): Aggregate::initialize Default:CheckIn
2023-06-25T17:08:38.145Z,1687712918.145 [Default:CheckIn:Read_GPS] Running Loop=1
2023-06-25T17:08:40.165Z,1687712920.165 [NAL9602](DEBUG): Parsing RMC sentence: $GPRMC,170839.00,A,4313.61786,N,08620.30234,W,0.991,344.89,250623,,,A*7A
2023-06-25T17:08:40.168Z,1687712920.168 [NAL9602](INFO): GPS fix at 20230625T170839: (43.226964, -86.338372)
2023-06-25T17:08:40.178Z,1687712920.178 [Default:CheckIn:Read_GPS] Stopped
2023-06-25T17:08:40.178Z,1687712920.178 [Default:CheckIn:Read_Iridium] Running Loop=1
2023-06-25T17:08:50.042Z,1687712930.042 [DataOverHttps](INFO): Sending 73 bytes from file Logs/20230625T161304/Courier0030.lzma
2023-06-25T17:08:51.045Z,1687712931.045 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Courier0030.lzma.bak
2023-06-25T17:08:51.045Z,1687712931.045 [DataOverHttps](INFO): SBD MOMSN=18428100
2023-06-25T17:09:10.102Z,1687712950.102 [DataOverHttps](INFO): Sending 218 bytes from file Logs/20230625T161304/Express0031.lzma
2023-06-25T17:09:11.104Z,1687712951.104 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Express0031.lzma.bak
2023-06-25T17:09:11.105Z,1687712951.105 [DataOverHttps](INFO): SBD MOMSN=18428103
2023-06-25T17:09:12.604Z,1687712952.604 [NAL9602](INFO): Not Powering down - fast GPS
2023-06-25T17:09:13.005Z,1687712953.005 [Default:CheckIn:Read_Iridium] Stopped
2023-06-25T17:09:13.005Z,1687712953.005 [Default:CheckIn:C.Wait] Running Loop=1
2023-06-25T17:09:13.005Z,1687712953.005 [Default:CheckIn:C.Wait](DEBUG): Initialize Wait Component.
2023-06-25T17:11:16.239Z,1687713076.239 [BPC1](ERROR): BPC1A got IPBS message with 6 sticks (min is 7).
2023-06-25T17:11:23.105Z,1687713083.105 [BPC1](ERROR): BPC1A got IPBS message with 6 sticks (min is 7).
2023-06-25T17:11:38.054Z,1687713098.054 [BPC1](ERROR): BPC1A got IPBS message with 6 sticks (min is 7).
2023-06-25T17:11:53.407Z,1687713113.407 [BPC1](ERROR): BPC1A got IPBS message with 6 sticks (min is 7).
2023-06-25T17:12:08.354Z,1687713128.354 [BPC1](ERROR): BPC1A got IPBS message with 6 sticks (min is 7).
2023-06-25T17:12:23.301Z,1687713143.301 [BPC1](ERROR): BPC1A got IPBS message with 6 sticks (min is 7).
2023-06-25T17:12:39.068Z,1687713159.068 [BPC1](ERROR): BPC1A got IPBS message with 6 sticks (min is 7).
2023-06-25T17:12:54.069Z,1687713174.069 [BPC1](ERROR): BPC1A got IPBS message with 6 sticks (min is 7).
2023-06-25T17:13:09.421Z,1687713189.421 [BPC1](ERROR): BPC1A got IPBS message with 6 sticks (min is 7).
2023-06-25T17:13:24.775Z,1687713204.775 [BPC1](ERROR): BPC1A got IPBS message with 6 sticks (min is 7).
2023-06-25T17:13:40.125Z,1687713220.125 [BPC1](ERROR): BPC1A got IPBS message with 5 sticks (min is 7).
2023-06-25T17:13:46.596Z,1687713226.596 [BPC1](INFO): Calculating totals. Valid battery stick count: 54. Valid reserve battery stick count: 6.
2023-06-25T17:13:46.611Z,1687713226.611 [BPC1](INFO): Received data from all battery sticks.
2023-06-25T17:14:13.674Z,1687713253.674 [Default:CheckIn:C.Wait](INFO): Done Waiting.
2023-06-25T17:14:13.674Z,1687713253.674 [Default:CheckIn:C.Wait] Stopped
2023-06-25T17:14:13.674Z,1687713253.674 [Default:CheckIn:C.Wait](DEBUG): Uninitialize Wait Component.
2023-06-25T17:14:13.675Z,1687713253.675 [Default:CheckIn:D] Running Loop=1
2023-06-25T17:14:14.081Z,1687713254.081 [Default:CheckIn:D] Stopped
2023-06-25T17:14:14.081Z,1687713254.081 [Default:CheckIn:E] Running Loop=1
2023-06-25T17:14:14.484Z,1687713254.484 [Default:CheckIn:E](IMPORTANT): Default mission has been running for 72.820052 min 
2023-06-25T17:14:14.486Z,1687713254.486 [Default:CheckIn:E] Stopped
2023-06-25T17:14:14.487Z,1687713254.487 [Default:CheckIn](INFO): Completed Default:CheckIn
2023-06-25T17:14:14.487Z,1687713254.487 [Default:CheckIn] Stopped
2023-06-25T17:14:14.487Z,1687713254.487 [Default:CheckIn](DEBUG): Aggregate::uninitialize Default:CheckIn
2023-06-25T17:14:14.487Z,1687713254.487 [Default:CheckIn](INFO): Running loop #13
2023-06-25T17:14:14.487Z,1687713254.487 [Default:CheckIn] Running Loop=13
2023-06-25T17:14:14.487Z,1687713254.487 [Default:CheckIn](DEBUG): Aggregate::initialize Default:CheckIn
2023-06-25T17:14:14.487Z,1687713254.487 [Default:CheckIn:Read_GPS] Running Loop=1
2023-06-25T17:14:16.493Z,1687713256.493 [NAL9602](DEBUG): Parsing RMC sentence: $GPRMC,171415.00,A,4313.62385,N,08620.31480,W,0.078,90.77,250623,,,A*40
2023-06-25T17:14:16.496Z,1687713256.496 [NAL9602](INFO): GPS fix at 20230625T171415: (43.227064, -86.338580)
2023-06-25T17:14:16.505Z,1687713256.505 [Default:CheckIn:Read_GPS] Stopped
2023-06-25T17:14:16.505Z,1687713256.505 [Default:CheckIn:Read_Iridium] Running Loop=1
2023-06-25T17:14:23.702Z,1687713263.702 [DataOverHttps](INFO): Sending 202 bytes from file Logs/20230625T161304/Courier0033.lzma
2023-06-25T17:14:24.704Z,1687713264.704 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Courier0033.lzma.bak
2023-06-25T17:14:24.704Z,1687713264.704 [DataOverHttps](INFO): SBD MOMSN=18428107
2023-06-25T17:14:40.234Z,1687713280.234 [DataOverHttps](INFO): Sending 139 bytes from file Logs/20230625T161304/Express0034.lzma
2023-06-25T17:14:41.236Z,1687713281.236 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Express0034.lzma.bak
2023-06-25T17:14:41.236Z,1687713281.236 [DataOverHttps](INFO): SBD MOMSN=18428111
2023-06-25T17:14:42.763Z,1687713282.763 [Default:CheckIn:Read_Iridium] Stopped
2023-06-25T17:14:42.763Z,1687713282.763 [Default:CheckIn:C.Wait] Running Loop=1
2023-06-25T17:14:42.763Z,1687713282.763 [Default:CheckIn:C.Wait](DEBUG): Initialize Wait Component.
2023-06-25T17:14:47.260Z,1687713287.260 [NAL9602](ERROR): Failed to receive proper response when querying signal strength for MT queue check.
2023-06-25T17:14:47.338Z,1687713287.338 [NAL9602](ERROR): received: 
+CSQ:0

OK
2023-06-25T17:19:18.112Z,1687713558.112 [NAL9602](FAULT): MT Queue status failed to be acquired within timeout. Will not retry this session.
2023-06-25T17:19:43.581Z,1687713583.581 [Default:CheckIn:C.Wait](INFO): Done Waiting.
2023-06-25T17:19:43.582Z,1687713583.582 [Default:CheckIn:C.Wait] Stopped
2023-06-25T17:19:43.582Z,1687713583.582 [Default:CheckIn:C.Wait](DEBUG): Uninitialize Wait Component.
2023-06-25T17:19:43.582Z,1687713583.582 [Default:CheckIn:D] Running Loop=1
2023-06-25T17:19:43.980Z,1687713583.980 [Default:CheckIn:D] Stopped
2023-06-25T17:19:43.980Z,1687713583.980 [Default:CheckIn:E] Running Loop=1
2023-06-25T17:19:44.380Z,1687713584.380 [Default:CheckIn:E](IMPORTANT): Default mission has been running for 78.318384 min 
2023-06-25T17:19:44.381Z,1687713584.381 [Default:CheckIn:E] Stopped
2023-06-25T17:19:44.381Z,1687713584.381 [Default:CheckIn](INFO): Completed Default:CheckIn
2023-06-25T17:19:44.381Z,1687713584.381 [Default:CheckIn] Stopped
2023-06-25T17:19:44.381Z,1687713584.381 [Default:CheckIn](DEBUG): Aggregate::uninitialize Default:CheckIn
2023-06-25T17:19:44.381Z,1687713584.381 [Default:CheckIn](INFO): Running loop #14
2023-06-25T17:19:44.381Z,1687713584.381 [Default:CheckIn] Running Loop=14
2023-06-25T17:19:44.381Z,1687713584.381 [Default:CheckIn](DEBUG): Aggregate::initialize Default:CheckIn
2023-06-25T17:19:44.381Z,1687713584.381 [Default:CheckIn:Read_GPS] Running Loop=1
2023-06-25T17:19:46.401Z,1687713586.401 [NAL9602](DEBUG): Parsing RMC sentence: $GPRMC,171945.00,A,4313.62017,N,08620.31056,W,0.952,90.77,250623,,,A*4E
2023-06-25T17:19:46.403Z,1687713586.403 [NAL9602](INFO): GPS fix at 20230625T171945: (43.227003, -86.338509)
2023-06-25T17:19:46.413Z,1687713586.413 [Default:CheckIn:Read_GPS] Stopped
2023-06-25T17:19:46.413Z,1687713586.413 [Default:CheckIn:Read_Iridium] Running Loop=1
2023-06-25T17:19:53.802Z,1687713593.802 [DataOverHttps](INFO): Sending 73 bytes from file Logs/20230625T161304/Courier0036.lzma
2023-06-25T17:19:54.804Z,1687713594.804 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Courier0036.lzma.bak
2023-06-25T17:19:54.804Z,1687713594.804 [DataOverHttps](INFO): SBD MOMSN=18428114
2023-06-25T17:20:10.338Z,1687713610.338 [DataOverHttps](INFO): Sending 206 bytes from file Logs/20230625T161304/Express0037.lzma
2023-06-25T17:20:11.340Z,1687713611.340 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Express0037.lzma.bak
2023-06-25T17:20:11.341Z,1687713611.341 [DataOverHttps](INFO): SBD MOMSN=18428117
2023-06-25T17:20:13.073Z,1687713613.073 [Default:CheckIn:Read_Iridium] Stopped
2023-06-25T17:20:13.073Z,1687713613.073 [Default:CheckIn:C.Wait] Running Loop=1
2023-06-25T17:20:13.073Z,1687713613.073 [Default:CheckIn:C.Wait](DEBUG): Initialize Wait Component.
2023-06-25T17:20:18.306Z,1687713618.306 [NAL9602](INFO): Not Powering down - fast GPS
2023-06-25T17:25:13.700Z,1687713913.700 [Default:CheckIn:C.Wait](INFO): Done Waiting.
2023-06-25T17:25:13.700Z,1687713913.700 [Default:CheckIn:C.Wait] Stopped
2023-06-25T17:25:13.700Z,1687713913.700 [Default:CheckIn:C.Wait](DEBUG): Uninitialize Wait Component.
2023-06-25T17:25:13.701Z,1687713913.701 [Default:CheckIn:D] Running Loop=1
2023-06-25T17:25:14.093Z,1687713914.093 [Default:CheckIn:D] Stopped
2023-06-25T17:25:14.093Z,1687713914.093 [Default:CheckIn:E] Running Loop=1
2023-06-25T17:25:14.498Z,1687713914.498 [Default:CheckIn:E](IMPORTANT): Default mission has been running for 83.820256 min 
2023-06-25T17:25:14.498Z,1687713914.498 [Default:CheckIn:E] Stopped
2023-06-25T17:25:14.498Z,1687713914.498 [Default:CheckIn](INFO): Completed Default:CheckIn
2023-06-25T17:25:14.498Z,1687713914.498 [Default:CheckIn] Stopped
2023-06-25T17:25:14.498Z,1687713914.498 [Default:CheckIn](DEBUG): Aggregate::uninitialize Default:CheckIn
2023-06-25T17:25:14.498Z,1687713914.498 [Default:CheckIn](INFO): Running loop #15
2023-06-25T17:25:14.499Z,1687713914.499 [Default:CheckIn] Running Loop=15
2023-06-25T17:25:14.499Z,1687713914.499 [Default:CheckIn](DEBUG): Aggregate::initialize Default:CheckIn
2023-06-25T17:25:14.499Z,1687713914.499 [Default:CheckIn:Read_GPS] Running Loop=1
2023-06-25T17:25:16.513Z,1687713916.513 [NAL9602](DEBUG): Parsing RMC sentence: $GPRMC,172515.00,A,4313.62653,N,08620.30972,W,0.136,90.77,250623,,,A*46
2023-06-25T17:25:16.516Z,1687713916.516 [NAL9602](INFO): GPS fix at 20230625T172515: (43.227109, -86.338495)
2023-06-25T17:25:16.526Z,1687713916.526 [Default:CheckIn:Read_GPS] Stopped
2023-06-25T17:25:16.526Z,1687713916.526 [Default:CheckIn:Read_Iridium] Running Loop=1
2023-06-25T17:25:23.578Z,1687713923.578 [DataOverHttps](INFO): Sending 73 bytes from file Logs/20230625T161304/Courier0039.lzma
2023-06-25T17:25:24.580Z,1687713924.580 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Courier0039.lzma.bak
2023-06-25T17:25:24.580Z,1687713924.580 [DataOverHttps](INFO): SBD MOMSN=18428121
2023-06-25T17:25:41.594Z,1687713941.594 [DataOverHttps](INFO): Sending 130 bytes from file Logs/20230625T161304/Express0040.lzma
2023-06-25T17:25:42.596Z,1687713942.596 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Express0040.lzma.bak
2023-06-25T17:25:42.596Z,1687713942.596 [DataOverHttps](INFO): SBD MOMSN=18428124
2023-06-25T17:25:44.393Z,1687713944.393 [Default:CheckIn:Read_Iridium] Stopped
2023-06-25T17:25:44.393Z,1687713944.393 [Default:CheckIn:C.Wait] Running Loop=1
2023-06-25T17:25:44.393Z,1687713944.393 [Default:CheckIn:C.Wait](DEBUG): Initialize Wait Component.
2023-06-25T17:25:47.208Z,1687713947.208 [NAL9602](ERROR): Failed to receive proper response when querying signal strength for MT queue check.
2023-06-25T17:25:47.290Z,1687713947.290 [NAL9602](ERROR): received: 
+CSQ:0

OK
2023-06-25T17:30:18.291Z,1687714218.291 [NAL9602](FAULT): MT Queue status failed to be acquired within timeout. Will not retry this session.
2023-06-25T17:30:44.964Z,1687714244.964 [Default:CheckIn:C.Wait](INFO): Done Waiting.
2023-06-25T17:30:44.964Z,1687714244.964 [Default:CheckIn:C.Wait] Stopped
2023-06-25T17:30:44.965Z,1687714244.964 [Default:CheckIn:C.Wait](DEBUG): Uninitialize Wait Component.
2023-06-25T17:30:44.965Z,1687714244.965 [Default:CheckIn:D] Running Loop=1
2023-06-25T17:30:45.369Z,1687714245.369 [Default:CheckIn:D] Stopped
2023-06-25T17:30:45.369Z,1687714245.369 [Default:CheckIn:E] Running Loop=1
2023-06-25T17:30:45.783Z,1687714245.783 [Default:CheckIn:E](IMPORTANT): Default mission has been running for 89.341528 min 
2023-06-25T17:30:45.783Z,1687714245.783 [Default:CheckIn:E] Stopped
2023-06-25T17:30:45.783Z,1687714245.783 [Default:CheckIn](INFO): Completed Default:CheckIn
2023-06-25T17:30:45.783Z,1687714245.783 [Default:CheckIn] Stopped
2023-06-25T17:30:45.783Z,1687714245.783 [Default:CheckIn](DEBUG): Aggregate::uninitialize Default:CheckIn
2023-06-25T17:30:45.784Z,1687714245.784 [Default:CheckIn](INFO): Running loop #16
2023-06-25T17:30:45.784Z,1687714245.784 [Default:CheckIn] Running Loop=16
2023-06-25T17:30:45.784Z,1687714245.784 [Default:CheckIn](DEBUG): Aggregate::initialize Default:CheckIn
2023-06-25T17:30:45.784Z,1687714245.784 [Default:CheckIn:Read_GPS] Running Loop=1
2023-06-25T17:30:47.789Z,1687714247.789 [NAL9602](DEBUG): Parsing RMC sentence: $GPRMC,173047.00,A,4313.61884,N,08620.31124,W,0.797,284.80,250623,,,A*7A
2023-06-25T17:30:47.800Z,1687714247.800 [NAL9602](INFO): GPS fix at 20230625T173047: (43.226981, -86.338521)
2023-06-25T17:30:47.810Z,1687714247.810 [Default:CheckIn:Read_GPS] Stopped
2023-06-25T17:30:47.810Z,1687714247.810 [Default:CheckIn:Read_Iridium] Running Loop=1
2023-06-25T17:30:57.434Z,1687714257.434 [DataOverHttps](INFO): Sending 73 bytes from file Logs/20230625T161304/Courier0042.lzma
2023-06-25T17:30:58.436Z,1687714258.436 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Courier0042.lzma.bak
2023-06-25T17:30:58.437Z,1687714258.437 [DataOverHttps](INFO): SBD MOMSN=18428127
2023-06-25T17:31:18.910Z,1687714278.910 [DataOverHttps](INFO): Sending 204 bytes from file Logs/20230625T161304/Express0043.lzma
2023-06-25T17:31:19.912Z,1687714279.912 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Express0043.lzma.bak
2023-06-25T17:31:19.912Z,1687714279.912 [DataOverHttps](INFO): SBD MOMSN=18428130
2023-06-25T17:31:20.227Z,1687714280.227 [NAL9602](INFO): Not Powering down - fast GPS
2023-06-25T17:31:21.457Z,1687714281.457 [Default:CheckIn:Read_Iridium] Stopped
2023-06-25T17:31:21.457Z,1687714281.457 [Default:CheckIn:C.Wait] Running Loop=1
2023-06-25T17:31:21.457Z,1687714281.457 [Default:CheckIn:C.Wait](DEBUG): Initialize Wait Component.
2023-06-25T17:36:22.077Z,1687714582.077 [Default:CheckIn:C.Wait](INFO): Done Waiting.
2023-06-25T17:36:22.077Z,1687714582.077 [Default:CheckIn:C.Wait] Stopped
2023-06-25T17:36:22.078Z,1687714582.078 [Default:CheckIn:C.Wait](DEBUG): Uninitialize Wait Component.
2023-06-25T17:36:22.078Z,1687714582.078 [Default:CheckIn:D] Running Loop=1
2023-06-25T17:36:22.473Z,1687714582.473 [Default:CheckIn:D] Stopped
2023-06-25T17:36:22.473Z,1687714582.473 [Default:CheckIn:E] Running Loop=1
2023-06-25T17:36:22.926Z,1687714582.926 [Default:CheckIn:E](IMPORTANT): Default mission has been running for 94.959920 min 
2023-06-25T17:36:22.926Z,1687714582.926 [Default:CheckIn:E] Stopped
2023-06-25T17:36:22.926Z,1687714582.926 [Default:CheckIn](INFO): Completed Default:CheckIn
2023-06-25T17:36:22.927Z,1687714582.927 [Default:CheckIn] Stopped
2023-06-25T17:36:22.927Z,1687714582.927 [Default:CheckIn](DEBUG): Aggregate::uninitialize Default:CheckIn
2023-06-25T17:36:22.927Z,1687714582.927 [Default:CheckIn](INFO): Running loop #17
2023-06-25T17:36:22.927Z,1687714582.927 [Default:CheckIn] Running Loop=17
2023-06-25T17:36:22.927Z,1687714582.927 [Default:CheckIn](DEBUG): Aggregate::initialize Default:CheckIn
2023-06-25T17:36:22.928Z,1687714582.928 [Default:CheckIn:Read_GPS] Running Loop=1
2023-06-25T17:36:24.893Z,1687714584.893 [NAL9602](DEBUG): Parsing RMC sentence: $GPRMC,173624.00,A,4313.61907,N,08620.33203,W,1.652,265.67,250623,,,A*78
2023-06-25T17:36:24.896Z,1687714584.896 [NAL9602](INFO): GPS fix at 20230625T173624: (43.226985, -86.338867)
2023-06-25T17:36:24.906Z,1687714584.906 [Default:CheckIn:Read_GPS] Stopped
2023-06-25T17:36:24.906Z,1687714584.906 [Default:CheckIn:Read_Iridium] Running Loop=1
2023-06-25T17:36:32.454Z,1687714592.454 [DataOverHttps](INFO): Sending 72 bytes from file Logs/20230625T161304/Courier0045.lzma
2023-06-25T17:36:33.456Z,1687714593.456 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Courier0045.lzma.bak
2023-06-25T17:36:33.456Z,1687714593.456 [DataOverHttps](INFO): SBD MOMSN=18428148
2023-06-25T17:36:48.998Z,1687714608.998 [DataOverHttps](INFO): Sending 139 bytes from file Logs/20230625T161304/Express0046.lzma
2023-06-25T17:36:50.000Z,1687714610.000 [DataOverHttps](INFO): Moved sent file to Logs/20230625T161304/Express0046.lzma.bak
2023-06-25T17:36:50.001Z,1687714610.001 [DataOverHttps](INFO): SBD MOMSN=18428151
2023-06-25T17:36:51.573Z,1687714611.573 [Default:CheckIn:Read_Iridium] Stopped
2023-06-25T17:36:51.573Z,1687714611.573 [Default:CheckIn:C.Wait] Running Loop=1
2023-06-25T17:36:51.574Z,1687714611.574 [Default:CheckIn:C.Wait](DEBUG): Initialize Wait Component.
2023-06-25T17:36:55.592Z,1687714615.592 [NAL9602](ERROR): Failed to receive proper response when querying signal strength for MT queue check.
2023-06-25T17:36:55.674Z,1687714615.674 [NAL9602](ERROR): received: 
+CSQ:0

OK
2023-06-25T17:38:01.683Z,1687714681.683 [CommandExec](IMPORTANT): got command configSet ElevatorServo.loadAtStartup 1 bool persist
2023-06-25T17:38:01.683Z,1687714681.683 [CommandExec](IMPORTANT): configSet ElevatorServo.loadAtStartup requires a restart to take effect.
2023-06-25T17:38:05.848Z,1687714685.848 [CommandExec](IMPORTANT): got command restart application
2023-06-25T17:38:06.851Z,1687714686.851 [CommandExec ThreadHandler](INFO): Uninitializing protected caller thread.
2023-06-25T17:38:06.851Z,1687714686.851 [CommandExec](INFO): Uninitializing the command executive.
2023-06-25T17:38:06.851Z,1687714686.851 [CommandExec](INFO): Uninitializing the command scheduler.
2023-06-25T17:38:06.851Z,1687714686.851 [CommandExec ThreadHandler](INFO): Thread cancelled.
2023-06-25T17:38:06.934Z,1687714686.934 [Supervisor](DEBUG): Uninitializing supervisor and starting cleanup.  Bye!
2023-06-25T17:38:06.935Z,1687714686.935 [ComponentRegistry](INFO): Shutting down NavChartDb ThreadHandler
2023-06-25T17:38:06.935Z,1687714686.935 [NavChartDb ThreadHandler](INFO): Thread cancelled.
2023-06-25T17:38:06.935Z,1687714686.935 [NavChartDb](INFO): Join timeout helper Thread ID is 5014
2023-06-25T17:38:07.290Z,1687714687.290 [NavChartDb ThreadHandler](INFO): Uninitializing protected caller thread.
2023-06-25T17:38:07.291Z,1687714687.291 [NavChartDb ThreadHandler](INFO): Thread cancelled.
2023-06-25T17:38:07.302Z,1687714687.302 [ComponentRegistry](INFO): Shutting down WetLabsBB2FL ThreadHandler
2023-06-25T17:38:07.303Z,1687714687.303 [WetLabsBB2FL ThreadHandler](INFO): Thread cancelled.
2023-06-25T17:38:07.303Z,1687714687.303 [WetLabsBB2FL](INFO): Join timeout helper Thread ID is 5015
2023-06-25T17:38:07.343Z,1687714687.343 [WetLabsBB2FL ThreadHandler](INFO): Uninitializing protected caller thread.
2023-06-25T17:38:07.343Z,1687714687.343 [WetLabsBB2FL](INFO): Powering down
2023-06-25T17:38:07.344Z,1687714687.344 [WetLabsBB2FL ThreadHandler](INFO): Thread cancelled.
2023-06-25T17:38:07.351Z,1687714687.351 [ComponentRegistry](INFO): Shutting down CTD_Seabird ThreadHandler
2023-06-25T17:38:07.351Z,1687714687.351 [CTD_Seabird ThreadHandler](INFO): Thread cancelled.
2023-06-25T17:38:07.351Z,1687714687.351 [CTD_Seabird](INFO): Join timeout helper Thread ID is 5016
2023-06-25T17:38:07.547Z,1687714687.547 [CTD_Seabird](INFO): Powering down
2023-06-25T17:38:07.559Z,1687714687.559 [CTD_Seabird ThreadHandler](INFO): Uninitializing protected caller thread.
2023-06-25T17:38:07.559Z,1687714687.559 [CTD_Seabird](INFO): Powering down
2023-06-25T17:38:07.570Z,1687714687.570 [CTD_Seabird ThreadHandler](INFO): Thread cancelled.
2023-06-25T17:38:07.575Z,1687714687.575 [ComponentRegistry](INFO): Shutting down Radio_Surface ThreadHandler
2023-06-25T17:38:07.575Z,1687714687.575 [Radio_Surface ThreadHandler](INFO): Thread cancelled.
2023-06-25T17:38:07.575Z,1687714687.575 [Radio_Surface](INFO): Join timeout helper Thread ID is 5017
2023-06-25T17:38:07.703Z,1687714687.703 [Radio_Surface](INFO): Powering down
2023-06-25T17:38:07.703Z,1687714687.703 [Radio_Surface ThreadHandler](INFO): Uninitializing protected caller thread.
2023-06-25T17:38:07.703Z,1687714687.703 [Radio_Surface ThreadHandler](INFO): Thread cancelled.
2023-06-25T17:38:07.714Z,1687714687.714 [ComponentRegistry](INFO): Shutting down Onboard ThreadHandler
2023-06-25T17:38:07.714Z,1687714687.714 [Onboard ThreadHandler](INFO): Thread cancelled.
2023-06-25T17:38:07.715Z,1687714687.715 [Onboard](INFO): Join timeout helper Thread ID is 5018
2023-06-25T17:38:08.927Z,1687714688.927 [Onboard ThreadHandler](INFO): Uninitializing protected caller thread.
2023-06-25T17:38:08.927Z,1687714688.927 [Onboard ThreadHandler](INFO): Thread cancelled.
2023-06-25T17:38:08.943Z,1687714688.943 [ComponentRegistry](INFO): Shutting down DataOverHttps ThreadHandler
2023-06-25T17:38:08.943Z,1687714688.943 [DataOverHttps ThreadHandler](INFO): Thread cancelled.
2023-06-25T17:38:08.944Z,1687714688.944 [DataOverHttps](INFO): Join timeout helper Thread ID is 5019
2023-06-25T17:38:09.694Z,1687714689.694 [DataOverHttps ThreadHandler](INFO): Uninitializing protected caller thread.
2023-06-25T17:38:09.697Z,1687714689.697 [DataOverHttps ThreadHandler](INFO): Thread cancelled.
2023-06-25T17:38:09.699Z,1687714689.699 [ComponentRegistry](INFO): Shutting down BackseatComponent ThreadHandler
2023-06-25T17:38:09.699Z,1687714689.699 [BackseatComponent ThreadHandler](INFO): Thread cancelled.
2023-06-25T17:38:09.700Z,1687714689.700 [BackseatComponent](INFO): Join timeout helper Thread ID is 5020
2023-06-25T17:38:09.783Z,1687714689.783 [BackseatComponent ThreadHandler](INFO): Uninitializing protected caller thread.
2023-06-25T17:38:09.783Z,1687714689.783 [BackseatComponent ThreadHandler](INFO): Thread cancelled.
2023-06-25T17:38:09.799Z,1687714689.799 [ComponentRegistry](INFO): Shutting down logger ThreadHandler
2023-06-25T17:38:09.800Z,1687714689.800 [logger ThreadHandler](INFO): Thread cancelled.
2023-06-25T17:38:09.800Z,1687714689.800 [logger](INFO): Join timeout helper Thread ID is 5021
2023-06-25T17:38:09.800Z,1687714689.800 [logger ThreadHandler](INFO): Uninitializing protected caller thread.
2023-06-25T17:38:09.800Z,1687714689.800 [logger ThreadHandler](INFO): Thread cancelled.
2023-06-25T17:38:09.802Z,1687714689.802 [ComponentRegistry](INFO): Shutting down CommandLine ThreadHandler
2023-06-25T17:38:09.802Z,1687714689.802 [CommandLine ThreadHandler](INFO): Thread cancelled.
2023-06-25T17:38:09.802Z,1687714689.802 [CommandLine](INFO): Join timeout helper Thread ID is 5022
2023-06-25T17:38:09.859Z,1687714689.859 [CommandLine ThreadHandler](INFO): Uninitializing protected caller thread.
2023-06-25T17:38:09.859Z,1687714689.859 [CommandLine ThreadHandler](INFO): Thread cancelled.
2023-06-25T17:38:09.863Z,1687714689.863 [ComponentRegistry](INFO): Shutting down CommandExec ThreadHandler
2023-06-25T17:38:09.863Z,1687714689.863 [CommandExec ThreadHandler](INFO): Thread cancelled.
2023-06-25T17:38:09.864Z,1687714689.864 [CommandExec](INFO): Join timeout helper Thread ID is 5023
2023-06-25T17:38:09.865Z,1687714689.865 [ComponentRegistry](INFO): Shutting down controlThread ThreadHandler
2023-06-25T17:38:09.865Z,1687714689.865 [controlThread ThreadHandler](INFO): Thread cancelled.
2023-06-25T17:38:09.865Z,1687714689.865 [controlThread](INFO): Join timeout helper Thread ID is 5024
2023-06-25T17:38:09.906Z,1687714689.906 [controlThread ThreadHandler](INFO): Uninitializing protected caller thread.
2023-06-25T17:38:09.907Z,1687714689.907 [controlThread](DEBUG): Uninitializing ControlThread
2023-06-25T17:38:09.907Z,1687714689.907 [AHRS_M2](INFO): Powering down
2023-06-25T17:38:09.979Z,1687714689.979 [NAL9602](INFO): Powering down
2023-06-25T17:38:09.980Z,1687714689.980 [Sonardyne_Nano](INFO): Powering down
2023-06-25T17:38:10.099Z,1687714690.099 [DepthRateCalculator](DEBUG): Uninitializing DepthRateCalculator.
2023-06-25T17:38:10.100Z,1687714690.100 [ElevatorOffsetCalculator](DEBUG): Uninitializing ElevatorOffsetCalculator.
2023-06-25T17:38:10.100Z,1687714690.100 [NavChart](DEBUG): Uninitialize NavChart Navigation.
2023-06-25T17:38:10.101Z,1687714690.101 [MissionManager](INFO): Uninitializing Mission Default
2023-06-25T17:38:10.101Z,1687714690.101 [Default] Stopped
2023-06-25T17:38:10.101Z,1687714690.101 [Default](DEBUG): Aggregate::uninitialize Default
2023-06-25T17:38:10.101Z,1687714690.101 [Default:B.GoToSurface] Stopped
2023-06-25T17:38:10.101Z,1687714690.101 [Default:B.GoToSurface](DEBUG): Uninitialize GoToSurfaceComponent.
2023-06-25T17:38:10.101Z,1687714690.101 [Default:CheckIn] Stopped
2023-06-25T17:38:10.101Z,1687714690.101 [Default:CheckIn](DEBUG): Aggregate::uninitialize Default:CheckIn
2023-06-25T17:38:10.102Z,1687714690.102 [Default:CheckIn:C.Wait] Stopped
2023-06-25T17:38:10.102Z,1687714690.102 [Default:CheckIn:C.Wait](DEBUG): Uninitialize Wait Component.
2023-06-25T17:38:10.104Z,1687714690.104 [VerticalControl](DEBUG): Uninitialize VerticalControlComponent.
2023-06-25T17:38:10.105Z,1687714690.105 [HorizontalControl](DEBUG): Uninitialize HorizontalControlComponent.
2023-06-25T17:38:10.105Z,1687714690.105 [SpeedControl](DEBUG): Uninitialize SpeedControlComponent.
2023-06-25T17:38:10.105Z,1687714690.105 [LoopControl](DEBUG): Uninitialize LoopControlComponent.
2023-06-25T17:38:10.106Z,1687714690.106 [BuoyancyServo](DEBUG): Uninitialize Buoyancy Servo.
2023-06-25T17:38:10.106Z,1687714690.106 [BuoyancyServo](INFO): Powering down
2023-06-25T17:38:10.118Z,1687714690.118 [MassServo](DEBUG): Uninitialize Mass Servo.
2023-06-25T17:38:10.119Z,1687714690.119 [MassServo](INFO): Powering down
2023-06-25T17:38:10.119Z,1687714690.119 [RudderServo](DEBUG): Uninitialize Rudder Servo.
2023-06-25T17:38:10.120Z,1687714690.120 [RudderServo](INFO): Powering down
2023-06-25T17:38:10.120Z,1687714690.120 [ThrusterHE](DEBUG): Uninitialize Thruster Servo.
2023-06-25T17:38:10.120Z,1687714690.120 [ThrusterHE](INFO): Powering down
2023-06-25T17:38:10.121Z,1687714690.121 [SBIT](DEBUG): Uninitialize SBIT Component.
2023-06-25T17:38:10.122Z,1687714690.122 [IBIT](DEBUG): Uninitialize IBIT Component.
2023-06-25T17:38:10.122Z,1687714690.122 [CBIT](DEBUG): Uninitialize CBIT Component.
2023-06-25T17:38:10.122Z,1687714690.122 [CBIT](DEBUG): Powering off loads.
2023-06-25T17:38:10.134Z,1687714690.134 [CBIT](DEBUG): Disabling WDT.
2023-06-25T17:38:10.146Z,1687714690.146 [CBIT](DEBUG): Opening all GF detection circuits.
2023-06-25T17:38:10.147Z,1687714690.147 [controlThread ThreadHandler](INFO): Thread cancelled.
2023-06-25T17:38:10.202Z,1687714690.202 [Radio_Surface ThreadHandler](INFO): Thread cancelled.
2023-06-25T17:38:10.205Z,1687714690.205 [Onboard ThreadHandler](INFO): Thread cancelled.
2023-06-25T17:38:10.211Z,1687714690.211 [DataOverHttps ThreadHandler](INFO): Thread cancelled.
2023-06-25T17:38:10.254Z,1687714690.254 [BackseatComponent ThreadHandler](INFO): Thread cancelled.
2023-06-25T17:38:10.291Z,1687714690.291 [WetLabsBB2FL ThreadHandler](INFO): Thread cancelled.
2023-06-25T17:38:10.294Z,1687714690.294 [CTD_Seabird ThreadHandler](INFO): Thread cancelled.
2023-06-25T17:38:10.326Z,1687714690.326 [NavChartDb ThreadHandler](INFO): Thread cancelled.
2023-06-25T17:38:10.395Z,1687714690.395 [logger ThreadHandler](INFO): Thread cancelled.