2025-10-14T20:31:48.845Z,1760473908.845 [CommandExec](IMPORTANT): got command restart logs 2025-10-14T20:35:56.442Z,1760474156.442 [DataOverHttps](IMPORTANT): SBD MTMSN=20251014T203549 2025-10-14T20:36:02.860Z,1760474162.860 [Default:CheckIn:C.Wait](INFO): Done Waiting. 2025-10-14T20:36:02.860Z,1760474162.860 [Default:CheckIn:C.Wait] Stopped 2025-10-14T20:36:02.861Z,1760474162.861 [Default:CheckIn:C.Wait](DEBUG): Uninitialize Wait Component. 2025-10-14T20:36:02.861Z,1760474162.861 [Default:CheckIn:D] Running Loop=1 2025-10-14T20:36:03.263Z,1760474163.263 [Default:CheckIn:D] Stopped 2025-10-14T20:36:03.263Z,1760474163.263 [Default:CheckIn:E] Running Loop=1 2025-10-14T20:36:03.669Z,1760474163.669 [Default:CheckIn:E](IMPORTANT): Default mission has been running for 11.312701 min 2025-10-14T20:36:03.669Z,1760474163.669 [Default:CheckIn:E] Stopped 2025-10-14T20:36:03.669Z,1760474163.669 [Default:CheckIn](INFO): Completed Default:CheckIn 2025-10-14T20:36:03.669Z,1760474163.669 [Default:CheckIn] Stopped 2025-10-14T20:36:03.669Z,1760474163.669 [Default:CheckIn](DEBUG): Aggregate::uninitialize Default:CheckIn 2025-10-14T20:36:03.669Z,1760474163.669 [Default:CheckIn](INFO): Running loop #3 2025-10-14T20:36:03.669Z,1760474163.669 [Default:CheckIn] Running Loop=3 2025-10-14T20:36:03.669Z,1760474163.669 [Default:CheckIn](DEBUG): Aggregate::initialize Default:CheckIn 2025-10-14T20:36:03.670Z,1760474163.670 [Default:CheckIn:Read_GPS] Running Loop=1 2025-10-14T20:36:05.695Z,1760474165.695 [NAL9602](DEBUG): Parsing RMC sentence: $GPRMC,203559.00,A,3645.81130,N,12152.26782,W,1.847,93.77,141025,,,D*41 2025-10-14T20:36:05.697Z,1760474165.697 [NAL9602](INFO): GPS fix at 20251014T203559: (36.763522, -121.871130) 2025-10-14T20:36:05.708Z,1760474165.708 [Default:CheckIn:Read_GPS] Stopped 2025-10-14T20:36:05.708Z,1760474165.708 [Default:CheckIn:Read_Iridium] Running Loop=1 2025-10-14T20:36:15.747Z,1760474175.747 [DataOverHttps](INFO): Sending 40 bytes from file Logs/20251014T202022/Courier0010.lzma 2025-10-14T20:36:15.750Z,1760474175.750 [DataOverHttps](INFO): Received command: configset verticalcontrol.buoyancyneutral 293 cc persist;configset verticalcontrol.massdefault 34 mm persist 2025-10-14T20:36:16.869Z,1760474176.869 [CommandExec](IMPORTANT): got command configSet VerticalControl.buoyancyNeutral 293 cubic_centimeter persist 2025-10-14T20:36:16.936Z,1760474176.936 [CommandExec](IMPORTANT): got command configSet VerticalControl.massDefault 34 millimeter persist 2025-10-14T20:36:17.150Z,1760474177.150 [DataOverHttps](INFO): Moved sent file to Logs/20251014T202022/Courier0010.lzma.bak 2025-10-14T20:36:17.151Z,1760474177.151 [DataOverHttps](INFO): SBD MOMSN=26200783 2025-10-14T20:36:28.356Z,1760474188.356 [NAL9602](INFO): SBD MO Status=2, MOMSN=23825, MT Status=2, MTMSN=0 2025-10-14T20:36:28.356Z,1760474188.356 [NAL9602](ERROR): Failed to initiate SBD session. Error code: 2 2025-10-14T20:36:33.280Z,1760474193.280 [DataOverHttps](INFO): Sending 272 bytes from file Logs/20251014T203148/Courier0000.lzma 2025-10-14T20:36:34.282Z,1760474194.282 [DataOverHttps](INFO): Moved sent file to Logs/20251014T203148/Courier0000.lzma.bak 2025-10-14T20:36:34.282Z,1760474194.282 [DataOverHttps](INFO): SBD MOMSN=26200786 2025-10-14T20:36:44.521Z,1760474204.521 [NAL9602](INFO): SBD MO Status=2, MOMSN=23825, MT Status=2, MTMSN=0 2025-10-14T20:36:44.521Z,1760474204.521 [NAL9602](ERROR): Failed to initiate SBD session. Error code: 2 2025-10-14T20:37:00.259Z,1760474220.259 [DataOverHttps](INFO): Sending 40 bytes from file Logs/20251014T203148/Courier0003.lzma 2025-10-14T20:37:01.262Z,1760474221.262 [DataOverHttps](INFO): Moved sent file to Logs/20251014T203148/Courier0003.lzma.bak 2025-10-14T20:37:01.262Z,1760474221.262 [DataOverHttps](INFO): SBD MOMSN=26200790 2025-10-14T20:37:17.744Z,1760474237.744 [DataOverHttps](INFO): Sending 40 bytes from file Logs/20251014T203148/Courier0005.lzma 2025-10-14T20:37:18.746Z,1760474238.746 [DataOverHttps](INFO): Moved sent file to Logs/20251014T203148/Courier0005.lzma.bak 2025-10-14T20:37:18.746Z,1760474238.746 [DataOverHttps](INFO): SBD MOMSN=26200792 2025-10-14T20:37:28.553Z,1760474248.553 [NAL9602](INFO): SBD MO Status=2, MOMSN=23825, MT Status=2, MTMSN=0 2025-10-14T20:37:28.553Z,1760474248.553 [NAL9602](ERROR): Failed to initiate SBD session. Error code: 2 2025-10-14T20:37:35.088Z,1760474255.088 [DataOverHttps](INFO): Sending 151 bytes from file Logs/20251014T202022/Express0011.lzma 2025-10-14T20:37:36.090Z,1760474256.090 [DataOverHttps](INFO): Moved sent file to Logs/20251014T202022/Express0011.lzma.bak 2025-10-14T20:37:36.090Z,1760474256.090 [DataOverHttps](INFO): SBD MOMSN=26200794 2025-10-14T20:37:37.128Z,1760474257.128 [RudderServo](ERROR): getPosition uart error serial timeout 2025-10-14T20:37:37.128Z,1760474257.128 [RudderServo](FAULT): Rudder uart error - getPosition..serial timeout 2025-10-14T20:37:37.128Z,1760474257.128 [RudderServo] Communications Fault, FailCount= 1 2025-10-14T20:37:37.128Z,1760474257.128 [RudderServo](ERROR): Communications Fault 2025-10-14T20:37:37.135Z,1760474257.135 [CBIT](ERROR): Communications Fault in component: RudderServo 2025-10-14T20:37:37.476Z,1760474257.476 [RudderServo](DEBUG): Uninitialize Rudder Servo. 2025-10-14T20:37:37.476Z,1760474257.476 [RudderServo](INFO): Powering down 2025-10-14T20:37:38.265Z,1760474258.265 [RudderServo](DEBUG): Initializing EZServoServo. 2025-10-14T20:37:38.381Z,1760474258.381 [RudderServo](DEBUG): Initializing RudderServo. 2025-10-14T20:37:38.385Z,1760474258.385 [CBIT](INFO): Clearing failed state for component RudderServo 2025-10-14T20:37:38.385Z,1760474258.385 [RudderServo] No Fault, FailCount= 1 2025-10-14T20:37:45.521Z,1760474265.521 [NAL9602](INFO): SBD MO Status=0, MOMSN=23825, MT Status=0, MTMSN=0 2025-10-14T20:37:45.521Z,1760474265.521 [NAL9602](INFO): No messages in MT queue 2025-10-14T20:37:52.401Z,1760474272.401 [DataOverHttps](INFO): Sending 602 bytes from file Logs/20251014T203148/Express0001.lzma 2025-10-14T20:37:53.402Z,1760474273.402 [DataOverHttps](INFO): Moved sent file to Logs/20251014T203148/Express0001.lzma.bak 2025-10-14T20:37:53.402Z,1760474273.402 [DataOverHttps](INFO): SBD MOMSN=26200797 2025-10-14T20:38:15.098Z,1760474295.098 [DataOverHttps](IMPORTANT): SBD MTMSN=20251014T203756 2025-10-14T20:38:16.223Z,1760474296.223 [NAL9602](INFO): Not Powering down - fast GPS 2025-10-14T20:38:22.817Z,1760474302.817 [DataOverHttps](INFO): Sending 154 bytes from file Logs/20251014T203148/Express0007.lzma 2025-10-14T20:38:22.823Z,1760474302.823 [DataOverHttps](INFO): Received command: configSet VerticalControl.elevLimit 15 degree persist 2025-10-14T20:38:23.229Z,1760474303.229 [CommandExec](IMPORTANT): got command configSet VerticalControl.elevLimit 15 degree persist 2025-10-14T20:38:24.069Z,1760474304.069 [DataOverHttps](INFO): Moved sent file to Logs/20251014T203148/Express0007.lzma.bak 2025-10-14T20:38:24.069Z,1760474304.069 [DataOverHttps](INFO): SBD MOMSN=26200804 2025-10-14T20:38:44.499Z,1760474324.499 [DataOverHttps](INFO): Sending 40 bytes from file Logs/20251014T203148/Courier0009.lzma 2025-10-14T20:38:45.502Z,1760474325.502 [DataOverHttps](INFO): Moved sent file to Logs/20251014T203148/Courier0009.lzma.bak 2025-10-14T20:38:45.502Z,1760474325.502 [DataOverHttps](INFO): SBD MOMSN=26200810 2025-10-14T20:39:01.940Z,1760474341.940 [DataOverHttps](INFO): Sending 259 bytes from file Logs/20251014T203148/Express0010.lzma 2025-10-14T20:39:02.942Z,1760474342.942 [DataOverHttps](INFO): Moved sent file to Logs/20251014T203148/Express0010.lzma.bak 2025-10-14T20:39:02.942Z,1760474342.942 [DataOverHttps](INFO): SBD MOMSN=26200817 2025-10-14T20:39:04.322Z,1760474344.322 [Default:CheckIn:Read_Iridium] Stopped 2025-10-14T20:39:04.322Z,1760474344.322 [Default:CheckIn:C.Wait] Running Loop=1 2025-10-14T20:39:04.323Z,1760474344.323 [Default:CheckIn:C.Wait](DEBUG): Initialize Wait Component. 2025-10-14T20:39:42.401Z,1760474382.401 [DataOverHttps](IMPORTANT): SBD MTMSN=20251014T203935 2025-10-14T20:39:49.997Z,1760474389.997 [DataOverHttps](INFO): Received command: ibit 2025-10-14T20:39:50.005Z,1760474390.005 [CommandExec](IMPORTANT): got command ibit 2025-10-14T20:39:50.117Z,1760474390.117 [IBIT](IMPORTANT): Beginning Initiated BIT 2025-10-14T20:39:50.118Z,1760474390.118 [IBIT](IMPORTANT): Beginning control surface checks. 2025-10-14T20:39:50.121Z,1760474390.121 [GFScanner](IMPORTANT): Beginning ground fault scan 2025-10-14T20:39:51.622Z,1760474391.622 [NAL9602](DEBUG): Parsing RMC sentence: $GPRMC,203945.00,A,3645.80602,N,12152.20937,W,1.516,94.29,141025,,,D*44 2025-10-14T20:39:51.625Z,1760474391.625 [NAL9602](INFO): GPS fix at 20251014T203945: (36.763434, -121.870156) 2025-10-14T20:39:54.593Z,1760474394.593 [GFScanner](IMPORTANT): No ground fault detected mA: CHAN A0 (Batt): -0.003346 CHAN A1 (24V): 0.008002 CHAN A2 (12V): -0.002575 CHAN A3 (5V): -0.001948 CHAN B0 (3.3V): -0.000627 CHAN B1 (3.15aV): -0.001208 CHAN B2 (3.15bV): -0.001243 CHAN B3 (GND): -0.000960 OPEN: 0.006736 Full Scale: +/- 1 mA 2025-10-14T20:40:43.474Z,1760474443.474 [IBIT](IMPORTANT): Communications Status: Fix Status: 1 Iridium Signal Strength: 2 Latitude: 36.763435 Longitude: -121.870155 2025-10-14T20:40:43.849Z,1760474443.849 [IBIT](FAULT): Warning: Battery Data not active. Expected only when running primaries. Threshold checking not active. 2025-10-14T20:40:44.257Z,1760474444.257 [IBIT](IMPORTANT): bitHumidityThreshold: 55.000000 % 2025-10-14T20:40:44.258Z,1760474444.258 [IBIT](IMPORTANT): bitPressureThreshold: 0.750000 psi 2025-10-14T20:40:44.258Z,1760474444.258 [IBIT](IMPORTANT): Pressure:9.948575 PSI 2025-10-14T20:40:44.258Z,1760474444.258 [IBIT](IMPORTANT): Humidity:8.191918 % 2025-10-14T20:40:44.679Z,1760474444.679 [IBIT](IMPORTANT): Vehicle Pitch:2.214068 degrees 2025-10-14T20:40:44.679Z,1760474444.679 [IBIT](IMPORTANT): Vehicle Roll:-8.482804 degrees 2025-10-14T20:40:44.680Z,1760474444.680 [IBIT](IMPORTANT): Vehicle Heading:62.387276 degrees 2025-10-14T20:40:45.077Z,1760474445.077 [IBIT](IMPORTANT): surfaceThreshold: 1.000000 m 2025-10-14T20:40:45.078Z,1760474445.078 [IBIT](IMPORTANT): buoyancyNeutral: 293.000000 cc 2025-10-14T20:40:45.078Z,1760474445.078 [IBIT](IMPORTANT): massDefault: 3.400000 cm 2025-10-14T20:40:45.078Z,1760474445.078 [IBIT](IMPORTANT): stopDepth: 275.000000 m 2025-10-14T20:40:45.078Z,1760474445.078 [IBIT](IMPORTANT): abortDepth: 300.000000 m 2025-10-14T20:40:45.079Z,1760474445.079 [IBIT](IMPORTANT): IBIT PASSED 2025-10-14T20:40:55.009Z,1760474455.009 [NAL9602](INFO): SBD MO Status=2, MOMSN=23826, MT Status=2, MTMSN=0 2025-10-14T20:40:55.009Z,1760474455.009 [NAL9602](ERROR): Failed to initiate SBD session. Error code: 2 2025-10-14T20:42:11.771Z,1760474531.771 [NAL9602](INFO): SBD MO Status=2, MOMSN=23826, MT Status=2, MTMSN=0 2025-10-14T20:42:11.771Z,1760474531.771 [NAL9602](ERROR): Failed to initiate SBD session. Error code: 2 2025-10-14T20:42:30.763Z,1760474550.763 [NAL9602](INFO): SBD MO Status=2, MOMSN=23826, MT Status=2, MTMSN=0 2025-10-14T20:42:30.764Z,1760474550.764 [NAL9602](ERROR): Failed to initiate SBD session. Error code: 2 2025-10-14T20:42:38.843Z,1760474558.843 [NAL9602](INFO): SBD MO Status=0, MOMSN=23826, MT Status=0, MTMSN=0 2025-10-14T20:42:38.843Z,1760474558.843 [NAL9602](INFO): No messages in MT queue 2025-10-14T20:43:01.706Z,1760474581.706 [DataOverHttps](IMPORTANT): SBD MTMSN=20251014T204254 2025-10-14T20:43:09.601Z,1760474589.601 [NAL9602](INFO): Not Powering down - fast GPS 2025-10-14T20:43:10.441Z,1760474590.441 [DataOverHttps](INFO): Received command: configSet Express linearApproximation PowerOnly.component_avgCurrent_loadControl 50 milliampere persist 2025-10-14T20:43:12.329Z,1760474592.329 [CommandExec](IMPORTANT): got command configSet Express linearApproximation PowerOnly.component_avgCurrent_loadControl 50 milliampere persist 2025-10-14T20:43:39.101Z,1760474619.101 [BPC1](ERROR): BPC1A failed to parse battery data due to unrecognized msg size. 2025-10-14T20:44:04.951Z,1760474644.951 [Default:CheckIn:C.Wait](INFO): Done Waiting. 2025-10-14T20:44:04.951Z,1760474644.951 [Default:CheckIn:C.Wait] Stopped 2025-10-14T20:44:04.951Z,1760474644.951 [Default:CheckIn:C.Wait](DEBUG): Uninitialize Wait Component. 2025-10-14T20:44:04.951Z,1760474644.951 [Default:CheckIn:D] Running Loop=1 2025-10-14T20:44:05.371Z,1760474645.371 [Default:CheckIn:D] Stopped 2025-10-14T20:44:05.371Z,1760474645.371 [Default:CheckIn:E] Running Loop=1 2025-10-14T20:44:05.765Z,1760474645.765 [Default:CheckIn:E](IMPORTANT): Default mission has been running for 19.347839 min 2025-10-14T20:44:05.765Z,1760474645.765 [Default:CheckIn:E] Stopped 2025-10-14T20:44:05.765Z,1760474645.765 [Default:CheckIn](INFO): Completed Default:CheckIn 2025-10-14T20:44:05.765Z,1760474645.765 [Default:CheckIn] Stopped 2025-10-14T20:44:05.765Z,1760474645.765 [Default:CheckIn](DEBUG): Aggregate::uninitialize Default:CheckIn 2025-10-14T20:44:05.765Z,1760474645.765 [Default:CheckIn](INFO): Running loop #4 2025-10-14T20:44:05.765Z,1760474645.765 [Default:CheckIn] Running Loop=4 2025-10-14T20:44:05.765Z,1760474645.765 [Default:CheckIn](DEBUG): Aggregate::initialize Default:CheckIn 2025-10-14T20:44:05.766Z,1760474645.766 [Default:CheckIn:Read_GPS] Running Loop=1 2025-10-14T20:44:07.841Z,1760474647.841 [NAL9602](DEBUG): Parsing RMC sentence: $GPRMC,204401.00,A,3645.80143,N,12152.13981,W,0.486,95.43,141025,,,D*45 2025-10-14T20:44:07.843Z,1760474647.843 [NAL9602](INFO): GPS fix at 20251014T204401: (36.763357, -121.868997) 2025-10-14T20:44:07.854Z,1760474647.854 [Default:CheckIn:Read_GPS] Stopped 2025-10-14T20:44:07.854Z,1760474647.854 [Default:CheckIn:Read_Iridium] Running Loop=1 2025-10-14T20:44:13.543Z,1760474653.543 [DataOverHttps](INFO): Sending 76 bytes from file Logs/20251014T203148/Courier0012.lzma 2025-10-14T20:44:14.546Z,1760474654.546 [DataOverHttps](INFO): Moved sent file to Logs/20251014T203148/Courier0012.lzma.bak 2025-10-14T20:44:14.546Z,1760474654.546 [DataOverHttps](INFO): SBD MOMSN=26200835 2025-10-14T20:44:21.272Z,1760474661.272 [NAL9602](INFO): SBD MO Status=0, MOMSN=23827, MT Status=0, MTMSN=0 2025-10-14T20:44:21.273Z,1760474661.273 [NAL9602](INFO): No messages in MT queue 2025-10-14T20:44:31.966Z,1760474671.966 [DataOverHttps](INFO): Sending 968 bytes from file Logs/20251014T203148/Express0013.lzma 2025-10-14T20:44:32.966Z,1760474672.966 [DataOverHttps](INFO): Moved sent file to Logs/20251014T203148/Express0013.lzma.bak 2025-10-14T20:44:32.966Z,1760474672.966 [DataOverHttps](INFO): SBD MOMSN=26200838 2025-10-14T20:44:34.494Z,1760474674.494 [Default:CheckIn:Read_Iridium] Stopped 2025-10-14T20:44:34.494Z,1760474674.494 [Default:CheckIn:C.Wait] Running Loop=1 2025-10-14T20:44:34.494Z,1760474674.494 [Default:CheckIn:C.Wait](DEBUG): Initialize Wait Component. 2025-10-14T20:44:51.572Z,1760474691.572 [NAL9602](INFO): Not Powering down - fast GPS 2025-10-14T20:47:46.291Z,1760474866.291 [DataOverHttps](IMPORTANT): SBD MTMSN=20251014T204739 2025-10-14T20:47:54.912Z,1760474874.912 [DataOverHttps](INFO): Received command: restart logs