1970-01-14T21:14:50.018Z,1199690.018 [Supervisor](DEBUG): Initializing supervisor.
1970-01-14T21:14:50.022Z,1199690.022 [SyncHandler](DEBUG): Created PCaller Thread at 404514E0
1970-01-14T21:14:50.023Z,1199690.023 [SyncHandler](INFO): Protected caller Thread ID is 6188
1970-01-14T21:14:50.023Z,1199690.023 [ComponentRegistry](DEBUG): Component "controlThread" handled in its own thread.
1970-01-14T21:14:50.024Z,1199690.024 [controlThread ThreadHandler](DEBUG): Created PCaller Thread at 404814E0
1970-01-14T21:14:50.024Z,1199690.024 [controlThread ThreadHandler](INFO): Protected caller Thread ID is 6189
1970-01-14T21:14:50.028Z,1199690.028 [ComponentRegistry](DEBUG): SyncComponent "CycleStarter" handled in the control thread.
1970-01-14T21:14:50.045Z,1199690.045 [ComponentRegistry](DEBUG): Component "CommandExec" handled in its own thread.
1970-01-14T21:14:50.046Z,1199690.046 [CommandExec ThreadHandler](DEBUG): Created PCaller Thread at 404B14E0
1970-01-14T21:14:50.047Z,1199690.047 [CommandExec ThreadHandler](INFO): Protected caller Thread ID is 6190
1970-01-14T21:14:50.051Z,1199690.051 [ComponentRegistry](DEBUG): Component "CommandLine" handled in its own thread.
1970-01-14T21:14:50.052Z,1199690.052 [CommandLine ThreadHandler](DEBUG): Created PCaller Thread at 404E14E0
1970-01-14T21:14:50.052Z,1199690.052 [CommandLine ThreadHandler](INFO): Protected caller Thread ID is 6191
1970-01-14T21:14:50.054Z,1199690.054 [ComponentRegistry](DEBUG): Component "logger" handled in its own thread.
1970-01-14T21:14:50.055Z,1199690.055 [logger ThreadHandler](DEBUG): Created PCaller Thread at 405114E0
1970-01-14T21:14:50.055Z,1199690.055 [logger ThreadHandler](INFO): Protected caller Thread ID is 6192
1970-01-14T21:14:50.059Z,1199690.059 [ComponentRegistry](DEBUG): SyncComponent "LogSplitter" handled in the control thread.
1970-01-14T21:14:50.059Z,1199690.059 [Supervisor](INFO): Looking for Config files in directory: Config/
1970-01-14T21:14:50.061Z,1199690.061 [Supervisor](INFO): Opening Config file at: Config/Sample.cfg
1970-01-14T21:14:50.138Z,1199690.138 [Supervisor](INFO): Opening Config file at: Config/workSite.cfg
1970-01-14T21:14:50.262Z,1199690.262 [ComponentRegistry](DEBUG): Loaded Config Component "Config/workSite
1970-01-14T21:14:50.263Z,1199690.263 [Supervisor](INFO): Opening Config file at: Config/Derivation.cfg
1970-01-14T21:14:50.459Z,1199690.459 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Derivation
1970-01-14T21:14:50.460Z,1199690.460 [Supervisor](INFO): Opening Config file at: Config/Science.cfg
1970-01-14T21:14:50.778Z,1199690.778 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Science
1970-01-14T21:14:50.778Z,1199690.778 [Supervisor](INFO): Opening Config file at: Config/logger.cfg
1970-01-14T21:14:50.952Z,1199690.952 [ComponentRegistry](DEBUG): Loaded Config Component "Config/logger
1970-01-14T21:14:50.953Z,1199690.953 [Supervisor](INFO): Opening Config file at: Config/Servo.cfg
1970-01-14T21:14:51.314Z,1199691.314 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Servo
1970-01-14T21:14:51.314Z,1199691.314 [Supervisor](INFO): Opening Config file at: Config/Estimation.cfg
1970-01-14T21:14:51.421Z,1199691.421 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Estimation
1970-01-14T21:14:51.422Z,1199691.422 [Supervisor](INFO): Opening Config file at: Config/secure.cfg
1970-01-14T21:14:51.516Z,1199691.516 [ComponentRegistry](DEBUG): Loaded Config Component "Config/secure
1970-01-14T21:14:51.516Z,1199691.516 [Supervisor](INFO): Opening Config file at: Config/Dock.cfg
1970-01-14T21:14:51.728Z,1199691.728 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Dock
1970-01-14T21:14:51.728Z,1199691.728 [Supervisor](INFO): Opening Config file at: Config/BIT.cfg
1970-01-14T21:14:51.921Z,1199691.921 [ComponentRegistry](DEBUG): Loaded Config Component "Config/BIT
1970-01-14T21:14:51.922Z,1199691.922 [Supervisor](INFO): Opening Config file at: Config/Guidance.cfg
1970-01-14T21:14:52.000Z,1199692.000 [Supervisor](INFO): Opening Config file at: Config/Control.cfg
1970-01-14T21:14:52.310Z,1199692.310 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Control
1970-01-14T21:14:52.311Z,1199692.311 [Supervisor](INFO): Opening Config file at: Config/vehicle.cfg
1970-01-14T21:14:52.777Z,1199692.777 [ComponentRegistry](DEBUG): Loaded Config Component "Config/vehicle
1970-01-14T21:14:52.778Z,1199692.778 [Supervisor](INFO): Opening Config file at: Config/Simulator.cfg
1970-01-14T21:14:53.334Z,1199693.334 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Simulator
1970-01-14T21:14:53.335Z,1199693.335 [Supervisor](INFO): Opening Config file at: Config/Sensor.cfg
1970-01-14T21:14:54.061Z,1199694.061 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Sensor
1970-01-14T21:14:54.062Z,1199694.062 [Supervisor](INFO): Opening Config file at: Config/Navigation.cfg
1970-01-14T21:14:54.341Z,1199694.341 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Navigation
1970-01-14T21:14:54.343Z,1199694.343 [Supervisor](INFO): Looking for Config files in directory: Config/lrauv-ahi/
1970-01-14T21:14:54.344Z,1199694.344 [Supervisor](INFO): Opening Config file at: Config/lrauv-ahi/Science.cfg
1970-01-14T21:14:54.467Z,1199694.467 [Supervisor](INFO): Opening Config file at: Config/lrauv-ahi/logger.cfg
1970-01-14T21:14:54.557Z,1199694.557 [Supervisor](INFO): Opening Config file at: Config/lrauv-ahi/Servo.cfg
1970-01-14T21:14:54.663Z,1199694.663 [Supervisor](INFO): Opening Config file at: Config/lrauv-ahi/secure.cfg
1970-01-14T21:14:54.751Z,1199694.751 [Supervisor](INFO): Opening Config file at: Config/lrauv-ahi/BIT.cfg
1970-01-14T21:14:54.857Z,1199694.857 [Supervisor](INFO): Opening Config file at: Config/lrauv-ahi/Control.cfg
1970-01-14T21:14:54.949Z,1199694.949 [Supervisor](INFO): Opening Config file at: Config/lrauv-ahi/Battery.cfg
1970-01-14T21:14:55.202Z,1199695.202 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Battery
1970-01-14T21:14:55.202Z,1199695.202 [Supervisor](INFO): Opening Config file at: Config/lrauv-ahi/vehicle.cfg
1970-01-14T21:14:55.353Z,1199695.353 [Supervisor](INFO): Opening Config file at: Config/lrauv-ahi/Simulator.cfg
1970-01-14T21:14:55.435Z,1199695.435 [Supervisor](INFO): Opening Config file at: Config/lrauv-ahi/Sensor.cfg
1970-01-14T21:14:55.579Z,1199695.579 [Supervisor](INFO): Opening Config file at: Config/lrauv-ahi/Navigation.cfg
1970-01-14T21:14:55.678Z,1199695.678 [Supervisor](INFO): Looking for Config files in directory: Config/lrauv-ahi/root/
1970-01-14T21:14:55.679Z,1199695.679 [Supervisor](IMPORTANT): Reading configuration overrides from Data/persisted.cfg
1970-01-14T21:14:55.680Z,1199695.680 [Module Loader](DEBUG): Loading Module at Modules/Dock.so
1970-01-14T21:14:55.777Z,1199695.777 [Module Loader](DEBUG): Loaded Module: Dock (Contains behaviors and commands for docking)
1970-01-14T21:14:55.778Z,1199695.778 [Module Loader](DEBUG): Loading Module at Modules/Sensor.so
1970-01-14T21:14:56.179Z,1199696.179 [AHRS_M2] Loaded
1970-01-14T21:14:56.180Z,1199696.180 [ComponentRegistry](DEBUG): SyncComponent "AHRS_M2" handled in the control thread.
1970-01-14T21:14:56.963Z,1199696.963 [BPC1] Loaded
1970-01-14T21:14:56.964Z,1199696.964 [ComponentRegistry](DEBUG): SyncComponent "BPC1" handled in the control thread.
1970-01-14T21:14:57.035Z,1199697.035 [DataOverHttps] Loaded
1970-01-14T21:14:57.035Z,1199697.035 [ComponentRegistry](DEBUG): Component "DataOverHttps" handled in its own thread.
1970-01-14T21:14:57.036Z,1199697.036 [DataOverHttps ThreadHandler](DEBUG): Created PCaller Thread at 408204E0
1970-01-14T21:14:57.037Z,1199697.037 [DataOverHttps ThreadHandler](INFO): Protected caller Thread ID is 6275
1970-01-14T21:14:57.057Z,1199697.057 [Depth_Keller] Loaded
1970-01-14T21:14:57.057Z,1199697.057 [ComponentRegistry](DEBUG): SyncComponent "Depth_Keller" handled in the control thread.
1970-01-14T21:14:57.062Z,1199697.062 [DropWeight] Loaded
1970-01-14T21:14:57.062Z,1199697.062 [ComponentRegistry](DEBUG): SyncComponent "DropWeight" handled in the control thread.
1970-01-14T21:14:57.123Z,1199697.123 [NAL9602] Loaded
1970-01-14T21:14:57.123Z,1199697.123 [ComponentRegistry](DEBUG): SyncComponent "NAL9602" handled in the control thread.
1970-01-14T21:14:57.150Z,1199697.150 [Onboard](ERROR): Can't open SysFS node file: /sys/class/power_supply/ds2782-0/voltage_now
1970-01-14T21:14:57.150Z,1199697.150 [Onboard](ERROR): Can't open SysFS node file: /sys/class/power_supply/ds2782-0/current_now
1970-01-14T21:14:57.151Z,1199697.151 [Onboard](ERROR): Can't open SysFS node file: /sys/class/power_supply/ds2782-0/charge_now
1970-01-14T21:14:57.151Z,1199697.151 [Onboard](ERROR): Can't open SysFS node file: /sys/class/power_supply/ds2782-0/charge_full
1970-01-14T21:14:57.152Z,1199697.152 [Onboard](ERROR): Can't open SysFS node file: /sys/class/power_supply/ds2782-1/voltage_now
1970-01-14T21:14:57.152Z,1199697.152 [Onboard](ERROR): Can't open SysFS node file: /sys/class/power_supply/ds2782-1/current_now
1970-01-14T21:14:57.153Z,1199697.153 [Onboard](ERROR): Can't open SysFS node file: /sys/class/power_supply/ds2782-1/charge_now
1970-01-14T21:14:57.153Z,1199697.153 [Onboard](ERROR): Can't open SysFS node file: /sys/class/power_supply/ds2782-1/charge_full
1970-01-14T21:14:57.153Z,1199697.153 [Onboard] Loaded
1970-01-14T21:14:57.154Z,1199697.154 [ComponentRegistry](DEBUG): Component "Onboard" handled in its own thread.
1970-01-14T21:14:57.155Z,1199697.155 [Onboard ThreadHandler](DEBUG): Created PCaller Thread at 408504E0
1970-01-14T21:14:57.155Z,1199697.155 [Onboard ThreadHandler](INFO): Protected caller Thread ID is 6276
1970-01-14T21:14:57.168Z,1199697.168 [Power24vConverter] Loaded
1970-01-14T21:14:57.168Z,1199697.168 [ComponentRegistry](DEBUG): SyncComponent "Power24vConverter" handled in the control thread.
1970-01-14T21:14:57.200Z,1199697.200 [PNI_TCM] Loaded
1970-01-14T21:14:57.201Z,1199697.201 [ComponentRegistry](DEBUG): SyncComponent "PNI_TCM" handled in the control thread.
1970-01-14T21:14:57.214Z,1199697.214 [Radio_Surface] Loaded
1970-01-14T21:14:57.214Z,1199697.215 [ComponentRegistry](DEBUG): Component "Radio_Surface" handled in its own thread.
1970-01-14T21:14:57.215Z,1199697.215 [Radio_Surface ThreadHandler](DEBUG): Created PCaller Thread at 408804E0
1970-01-14T21:14:57.216Z,1199697.216 [Radio_Surface ThreadHandler](INFO): Protected caller Thread ID is 6277
1970-01-14T21:14:57.333Z,1199697.333 [DAT] Loaded
1970-01-14T21:14:57.333Z,1199697.333 [ComponentRegistry](DEBUG): Component "DAT" handled in its own thread.
1970-01-14T21:14:57.334Z,1199697.334 [DAT ThreadHandler](DEBUG): Created PCaller Thread at 408B04E0
1970-01-14T21:14:57.334Z,1199697.334 [DAT ThreadHandler](INFO): Protected caller Thread ID is 6278
1970-01-14T21:14:57.335Z,1199697.335 [Module Loader](DEBUG): Loaded Module: Sensor (Contains the sensor components)
1970-01-14T21:14:57.335Z,1199697.335 [Module Loader](DEBUG): Loading Module at Modules/Trigger.so
1970-01-14T21:14:57.363Z,1199697.363 [Module Loader](DEBUG): Loaded Module: Trigger (Contains triggers for use in missions)
1970-01-14T21:14:57.363Z,1199697.363 [Module Loader](DEBUG): Loading Module at Modules/Sample.so
1970-01-14T21:14:57.373Z,1199697.373 [Module Loader](DEBUG): Loaded Module: Sample (This is a Sample Module of Sample Components)
1970-01-14T21:14:57.374Z,1199697.374 [Module Loader](DEBUG): Loading Module at Modules/Derivation.so
1970-01-14T21:14:57.425Z,1199697.425 [DepthRateCalculator] Loaded
1970-01-14T21:14:57.425Z,1199697.425 [ComponentRegistry](DEBUG): SyncComponent "DepthRateCalculator" handled in the control thread.
1970-01-14T21:14:57.431Z,1199697.431 [PitchRateCalculator] Loaded
1970-01-14T21:14:57.431Z,1199697.431 [ComponentRegistry](DEBUG): SyncComponent "PitchRateCalculator" handled in the control thread.
1970-01-14T21:14:57.441Z,1199697.441 [SpeedCalculator] Loaded
1970-01-14T21:14:57.441Z,1199697.441 [ComponentRegistry](DEBUG): SyncComponent "SpeedCalculator" handled in the control thread.
1970-01-14T21:14:57.446Z,1199697.446 [YawRateCalculator] Loaded
1970-01-14T21:14:57.446Z,1199697.446 [ComponentRegistry](DEBUG): SyncComponent "YawRateCalculator" handled in the control thread.
1970-01-14T21:14:57.468Z,1199697.468 [ElevatorOffsetCalculator] Loaded
1970-01-14T21:14:57.468Z,1199697.468 [ComponentRegistry](DEBUG): SyncComponent "ElevatorOffsetCalculator" handled in the control thread.
1970-01-14T21:14:57.468Z,1199697.468 [Module Loader](DEBUG): Loaded Module: Derivation (Contains the base derivation components)
1970-01-14T21:14:57.469Z,1199697.469 [Module Loader](DEBUG): Loading Module at Modules/Simulator.so
1970-01-14T21:14:57.614Z,1199697.614 [Module Loader](DEBUG): Loaded Module: Simulator (This is the module containing the Simulator)
1970-01-14T21:14:57.614Z,1199697.614 [Module Loader](DEBUG): Loading Module at Modules/Estimation.so
1970-01-14T21:14:57.670Z,1199697.670 [Module Loader](DEBUG): Loaded Module: Estimation (Contains the base estimation components)
1970-01-14T21:14:57.671Z,1199697.671 [Module Loader](DEBUG): Loading Module at Modules/Navigation.so
1970-01-14T21:14:57.780Z,1199697.780 [DeadReckonUsingMultipleVelocitySources] Loaded
1970-01-14T21:14:57.781Z,1199697.781 [ComponentRegistry](DEBUG): SyncComponent "DeadReckonUsingMultipleVelocitySources" handled in the control thread.
1970-01-14T21:14:57.821Z,1199697.821 [DeadReckonUsingSpeedCalculator] Loaded
1970-01-14T21:14:57.821Z,1199697.821 [ComponentRegistry](DEBUG): SyncComponent "DeadReckonUsingSpeedCalculator" handled in the control thread.
1970-01-14T21:14:57.862Z,1199697.862 [DeadReckonWithRespectToSeafloor] Loaded
1970-01-14T21:14:57.862Z,1199697.862 [ComponentRegistry](DEBUG): SyncComponent "DeadReckonWithRespectToSeafloor" handled in the control thread.
1970-01-14T21:14:57.875Z,1199697.875 [NavChart] Loaded
1970-01-14T21:14:57.876Z,1199697.876 [ComponentRegistry](DEBUG): SyncComponent "NavChart" handled in the control thread.
1970-01-14T21:14:57.881Z,1199697.881 [UniversalFixResidualReporter] Loaded
1970-01-14T21:14:57.881Z,1199697.881 [ComponentRegistry](DEBUG): SyncComponent "UniversalFixResidualReporter" handled in the control thread.
1970-01-14T21:14:57.882Z,1199697.882 [Module Loader](DEBUG): Loaded Module: Navigation (Contains the base navigation components)
1970-01-14T21:14:57.882Z,1199697.882 [Module Loader](DEBUG): Loading Module at Modules/Guidance.so
1970-01-14T21:14:58.187Z,1199698.187 [Module Loader](DEBUG): Loaded Module: Guidance (Contains behaviors and commands)
1970-01-14T21:14:58.187Z,1199698.187 [Module Loader](DEBUG): Loading Module at Modules/BIT.so
1970-01-14T21:14:58.324Z,1199698.324 [SBIT](DEBUG): Construct Startup Built In Test.
1970-01-14T21:14:58.338Z,1199698.338 [SBIT] Loaded
1970-01-14T21:14:58.338Z,1199698.338 [ComponentRegistry](DEBUG): SyncComponent "SBIT" handled in the control thread.
1970-01-14T21:14:58.341Z,1199698.341 [IBIT](DEBUG): Construct Initiated Built In Test.
1970-01-14T21:14:58.354Z,1199698.354 [IBIT] Loaded
1970-01-14T21:14:58.354Z,1199698.354 [ComponentRegistry](DEBUG): SyncComponent "IBIT" handled in the control thread.
1970-01-14T21:14:58.360Z,1199698.360 [CBIT](DEBUG): Construct Continuous Built In Test.
1970-01-14T21:14:58.460Z,1199698.460 [CBIT] Loaded
1970-01-14T21:14:58.460Z,1199698.460 [ComponentRegistry](DEBUG): SyncComponent "CBIT" handled in the control thread.
1970-01-14T21:14:58.461Z,1199698.461 [Module Loader](DEBUG): Loaded Module: BIT (Contains the BuiltInTest components, such as C Built In Test)
1970-01-14T21:14:58.461Z,1199698.461 [Module Loader](DEBUG): Loading Module at Modules/Control.so
1970-01-14T21:14:58.511Z,1199698.511 [VerticalControl](DEBUG): Construct VerticalControl.
1970-01-14T21:14:58.563Z,1199698.563 [VerticalControl] Loaded
1970-01-14T21:14:58.564Z,1199698.564 [ComponentRegistry](DEBUG): SyncComponent "VerticalControl" handled in the control thread.
1970-01-14T21:14:58.567Z,1199698.567 [HorizontalControl](DEBUG): Construct HorizontalControl.
1970-01-14T21:14:58.604Z,1199698.604 [HorizontalControl] Loaded
1970-01-14T21:14:58.605Z,1199698.605 [ComponentRegistry](DEBUG): SyncComponent "HorizontalControl" handled in the control thread.
1970-01-14T21:14:58.607Z,1199698.607 [SpeedControl](DEBUG): Construct SpeedControl.
1970-01-14T21:14:58.610Z,1199698.610 [SpeedControl] Loaded
1970-01-14T21:14:58.610Z,1199698.610 [ComponentRegistry](DEBUG): SyncComponent "SpeedControl" handled in the control thread.
1970-01-14T21:14:58.613Z,1199698.613 [LoopControl](DEBUG): Construct LoopControl.
1970-01-14T21:14:58.613Z,1199698.613 [LoopControl] Loaded
1970-01-14T21:14:58.613Z,1199698.613 [ComponentRegistry](DEBUG): SyncComponent "LoopControl" handled in the control thread.
1970-01-14T21:14:58.614Z,1199698.614 [Module Loader](DEBUG): Loaded Module: Control (Contains the Control components, such as Depth, Heading, and Speed Control)
1970-01-14T21:14:58.614Z,1199698.614 [Module Loader](DEBUG): Loading Module at Modules/Science.so
1970-01-14T21:14:58.748Z,1199698.748 [Aanderaa_O2] Loaded
1970-01-14T21:14:58.749Z,1199698.749 [ComponentRegistry](DEBUG): SyncComponent "Aanderaa_O2" handled in the control thread.
1970-01-14T21:14:58.807Z,1199698.807 [CTD_Seabird] Loaded
1970-01-14T21:14:58.808Z,1199698.808 [ComponentRegistry](DEBUG): Component "CTD_Seabird" handled in its own thread.
1970-01-14T21:14:58.809Z,1199698.809 [CTD_Seabird ThreadHandler](DEBUG): Created PCaller Thread at 40B104E0
1970-01-14T21:14:58.809Z,1199698.809 [CTD_Seabird ThreadHandler](INFO): Protected caller Thread ID is 6279
1970-01-14T21:14:58.841Z,1199698.841 [ESPComponent] Loaded
1970-01-14T21:14:58.842Z,1199698.842 [ComponentRegistry](DEBUG): SyncComponent "ESPComponent" handled in the control thread.
1970-01-14T21:14:58.861Z,1199698.861 [PAR_Licor] Loaded
1970-01-14T21:14:58.861Z,1199698.861 [ComponentRegistry](DEBUG): SyncComponent "PAR_Licor" handled in the control thread.
1970-01-14T21:14:58.892Z,1199698.892 [WetLabsBB2FL] Loaded
1970-01-14T21:14:58.892Z,1199698.892 [ComponentRegistry](DEBUG): Component "WetLabsBB2FL" handled in its own thread.
1970-01-14T21:14:58.893Z,1199698.893 [WetLabsBB2FL ThreadHandler](DEBUG): Created PCaller Thread at 40B404E0
1970-01-14T21:14:58.893Z,1199698.893 [WetLabsBB2FL ThreadHandler](INFO): Protected caller Thread ID is 6280
1970-01-14T21:14:58.894Z,1199698.894 [Module Loader](DEBUG): Loaded Module: Science (Contains the science components)
1970-01-14T21:14:58.895Z,1199698.895 [Module Loader](DEBUG): Loading Module at Modules/Servo.so
1970-01-14T21:14:59.024Z,1199699.024 [BuoyancyServo] Loaded
1970-01-14T21:14:59.024Z,1199699.024 [ComponentRegistry](DEBUG): SyncComponent "BuoyancyServo" handled in the control thread.
1970-01-14T21:14:59.044Z,1199699.044 [ElevatorServo] Loaded
1970-01-14T21:14:59.045Z,1199699.045 [ComponentRegistry](DEBUG): SyncComponent "ElevatorServo" handled in the control thread.
1970-01-14T21:14:59.064Z,1199699.064 [MassServo] Loaded
1970-01-14T21:14:59.064Z,1199699.064 [ComponentRegistry](DEBUG): SyncComponent "MassServo" handled in the control thread.
1970-01-14T21:14:59.082Z,1199699.082 [RudderServo] Loaded
1970-01-14T21:14:59.083Z,1199699.083 [ComponentRegistry](DEBUG): SyncComponent "RudderServo" handled in the control thread.
1970-01-14T21:14:59.097Z,1199699.097 [ThrusterHE] Loaded
1970-01-14T21:14:59.098Z,1199699.098 [ComponentRegistry](DEBUG): SyncComponent "ThrusterHE" handled in the control thread.
1970-01-14T21:14:59.098Z,1199699.098 [Module Loader](DEBUG): Loaded Module: Servo (This is the module containing motor controllers)
1970-01-14T21:14:59.104Z,1199699.104 [ComponentRegistry](DEBUG): SyncComponent "MissionManager" handled in the control thread.
1970-01-14T21:14:59.107Z,1199699.107 [ComponentRegistry](DEBUG): SyncComponent "Reporter" handled in the control thread.
1970-01-14T21:14:59.118Z,1199699.118 [ComponentRegistry](DEBUG): Component "NavChartDb" handled in its own thread.
1970-01-14T21:14:59.119Z,1199699.119 [NavChartDb ThreadHandler](DEBUG): Created PCaller Thread at 40BA64E0
1970-01-14T21:14:59.119Z,1199699.119 [NavChartDb ThreadHandler](INFO): Protected caller Thread ID is 6281
1970-01-14T21:14:59.123Z,1199699.123 [Supervisor](INFO): Main Thread ID is 6187
1970-01-14T21:14:59.124Z,1199699.124 [Supervisor](DEBUG): Running supervisor.
1970-01-14T21:14:59.124Z,1199699.124 [CommandExec ThreadHandler](INFO): Handler Thread ID is 6282
1970-01-14T21:14:59.125Z,1199699.125 [CommandExec](INFO): Initializing the command executive.
1970-01-14T21:14:59.126Z,1199699.126 [CommandLine ThreadHandler](INFO): Handler Thread ID is 6283
1970-01-14T21:14:59.133Z,1199699.133 [controlThread ThreadHandler](INFO): Handler Thread ID is 6284
1970-01-14T21:14:59.133Z,1199699.133 [controlThread](DEBUG): Initializing ControlThread
1970-01-14T21:14:59.139Z,1199699.139 [DepthRateCalculator](DEBUG): Initializing DepthRateCalculator.
1970-01-14T21:14:59.139Z,1199699.139 [PitchRateCalculator](DEBUG): Initializing PitchRateCalculator.
1970-01-14T21:14:59.139Z,1199699.139 [SpeedCalculator](DEBUG): Initializing SpeedCalculator.
1970-01-14T21:14:59.140Z,1199699.140 [YawRateCalculator](DEBUG): Initializing YawRateCalculator.
1970-01-14T21:14:59.140Z,1199699.140 [ElevatorOffsetCalculator](DEBUG): Initializing ElevatorOffsetCalculator.
1970-01-14T21:14:59.141Z,1199699.141 [DeadReckonUsingSpeedCalculator](DEBUG): Initializing DeadReckonUsingSpeedCalculator component.
1970-01-14T21:14:59.142Z,1199699.142 [NavChart](DEBUG): Initialize NavChart Navigation.
1970-01-14T21:14:59.142Z,1199699.142 [UniversalFixResidualReporter](DEBUG): Initializing UniversalFixResidualReporter component.
1970-01-14T21:14:59.142Z,1199699.142 [SBIT](INFO): Initialize SBIT Component.
1970-01-14T21:14:59.143Z,1199699.143 [SBIT](IMPORTANT): git: 2023-01-26
1970-01-14T21:14:59.143Z,1199699.143 [SBIT](INFO): git hash: fbcd350f88251f9a867f3fca05699dec8f096e0d
1970-01-14T21:14:59.143Z,1199699.143 [SBIT](IMPORTANT): Kernel Release: 2.6.27.8
1970-01-14T21:14:59.145Z,1199699.145 [SBIT](INFO): Kernel Reporting Different Version From Configuration.
Kernel Expected: #639 PREEMPT Wed Mar 12 12:53:33 PDT 2014
Kernel Reported: #2 PREEMPT Thu Jan 11 20:13:48 PST 2018
1970-01-14T21:14:59.146Z,1199699.146 [SBIT](INFO): Beginning SBIT in 71.000000 seconds.
1970-01-14T21:14:59.147Z,1199699.147 [IBIT](INFO): Initialize IBIT Component.
1970-01-14T21:14:59.147Z,1199699.147 [CBIT](DEBUG): Initialize CBIT Component.
1970-01-14T21:14:59.148Z,1199699.148 [logger ThreadHandler](INFO): Handler Thread ID is 6285
1970-01-14T21:14:59.161Z,1199699.161 [CBIT](DEBUG): Initialized mux pins.
1970-01-14T21:14:59.161Z,1199699.161 [CBIT](DEBUG): Initializing the watchdog timer.
1970-01-14T21:14:59.165Z,1199699.165 [DataOverHttps ThreadHandler](INFO): Handler Thread ID is 6286
1970-01-14T21:14:59.166Z,1199699.166 [DataOverHttps](DEBUG): dashIP=134.89.2.23 starts with a digit so assuming it is a numeric IP
1970-01-14T21:14:59.173Z,1199699.173 [Onboard ThreadHandler](INFO): Handler Thread ID is 6287
1970-01-14T21:14:59.186Z,1199699.186 [CBIT](INFO): Last reboot was NOT due to watchdog timer.
1970-01-14T21:14:59.186Z,1199699.186 [CBIT](DEBUG): Initializing heartbeat.
1970-01-14T21:14:59.193Z,1199699.193 [Radio_Surface ThreadHandler](INFO): Handler Thread ID is 6288
1970-01-14T21:14:59.209Z,1199699.209 [DAT ThreadHandler](INFO): Handler Thread ID is 6289
1970-01-14T21:14:59.212Z,1199699.212 [DAT](INFO): Powering up
1970-01-14T21:14:59.212Z,1199699.212 [DAT](DEBUG): Initializing DAT.
1970-01-14T21:14:59.214Z,1199699.214 [CTD_Seabird ThreadHandler](INFO): Handler Thread ID is 6291
1970-01-14T21:14:59.215Z,1199699.215 [CTD_Seabird](DEBUG): Initializing CTD_Seabird.
1970-01-14T21:14:59.218Z,1199699.218 [WetLabsBB2FL ThreadHandler](INFO): Handler Thread ID is 6293
1970-01-14T21:14:59.221Z,1199699.221 [WetLabsBB2FL](INFO): Powering up
1970-01-14T21:14:59.223Z,1199699.223 [NavChartDb ThreadHandler](INFO): Handler Thread ID is 6295
1970-01-14T21:14:59.226Z,1199699.226 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US2HA05M.000
1970-01-14T21:14:59.226Z,1199699.226 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US2HA05M.000
1970-01-14T21:14:59.226Z,1199699.226 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US3HA20M.000
1970-01-14T21:14:59.226Z,1199699.226 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US3HA20M.000
1970-01-14T21:14:59.227Z,1199699.227 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US4HA51M.000
1970-01-14T21:14:59.227Z,1199699.227 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US4HA51M.000
1970-01-14T21:14:59.227Z,1199699.227 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US4HA51M.000
1970-01-14T21:14:59.227Z,1199699.227 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US4HA51M.000
1970-01-14T21:14:59.227Z,1199699.227 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US5HA53M.000
1970-01-14T21:14:59.227Z,1199699.227 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US5HA53M.000
1970-01-14T21:14:59.227Z,1199699.227 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US5HA55M.000
1970-01-14T21:14:59.228Z,1199699.228 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US5HA55M.000
1970-01-14T21:14:59.257Z,1199699.257 [CBIT](DEBUG): Deactivating GF circuits.
1970-01-14T21:14:59.257Z,1199699.257 [CBIT](DEBUG): Deactivating emergency mode.
1970-01-14T21:14:59.293Z,1199699.293 [CBIT](DEBUG): Backplane powered.
1970-01-14T21:14:59.293Z,1199699.293 [VerticalControl](DEBUG): Initialize VerticalControlComponent.
1970-01-14T21:14:59.295Z,1199699.295 [HorizontalControl](DEBUG): Initialize HorizontalControlComponent.
1970-01-14T21:14:59.296Z,1199699.296 [SpeedControl](DEBUG): Initialize SpeedControlComponent.
1970-01-14T21:14:59.296Z,1199699.296 [LoopControl](DEBUG): Initialize LoopControlComponent.
1970-01-14T21:14:59.303Z,1199699.303 [MissionManager](INFO): Loading Mission from file: Missions/Startup.xml
1970-01-14T21:14:59.332Z,1199699.332 [Startup:A.GoToSurface](DEBUG): Construct GoToSurface.
1970-01-14T21:14:59.363Z,1199699.363 [MissionManager](DEBUG):
1970-01-14T21:14:59.364Z,1199699.364 [MissionManager](INFO): Loading Mission from file: Missions/Default.xml
1970-01-14T21:14:59.467Z,1199699.467 [MissionManager](INFO): DefineArg Default.ElapsedSinceDefaultStarted = 0.000000 min
1970-01-14T21:14:59.468Z,1199699.468 [Default:A.Wait](DEBUG): Construct Wait.
1970-01-14T21:14:59.471Z,1199699.471 [Default:B.GoToSurface](DEBUG): Construct GoToSurface.
1970-01-14T21:14:59.511Z,1199699.511 [Default:CheckIn:Read_Iridium:A_Timeout:A.Execute](DEBUG): Construct Execute.
1970-01-14T21:14:59.514Z,1199699.514 [Default:CheckIn:C.Wait](DEBUG): Construct Wait.
1970-01-14T21:14:59.558Z,1199699.558 [Default:E.Execute](DEBUG): Construct Execute.
1970-01-14T21:14:59.562Z,1199699.562 [MissionManager](DEBUG):
0
Wait a moment to see if the scheduler starts a new mission before
starting to actually run Default.
13
Burn on
Dropped weight due to communications timeout.
5
Default mission has been running for
Restarting logs and Default mission.
restart logs
1970-01-14T21:14:59.569Z,1199699.569 [controlThread](DEBUG): Component order: CycleStarter,AHRS_M2,BPC1,Depth_Keller,DropWeight,NAL9602,Power24vConverter,PNI_TCM,Aanderaa_O2,ESPComponent,PAR_Licor,Depth_Keller,PAR_Licor,DepthRateCalculator,PitchRateCalculator,SpeedCalculator,YawRateCalculator,ElevatorOffsetCalculator,DeadReckonUsingMultipleVelocitySources,DeadReckonUsingSpeedCalculator,DeadReckonWithRespectToSeafloor,NavChart,UniversalFixResidualReporter,MissionManager,VerticalControl,HorizontalControl,SpeedControl,LoopControl,BuoyancyServo,ElevatorServo,MassServo,RudderServo,ThrusterHE,SBIT,IBIT,CBIT,Reporter,LogSplitter,
1970-01-14T21:14:59.589Z,1199699.589 [AHRS_M2](DEBUG): Initializing AHRS_M2.
1970-01-14T21:14:59.597Z,1199699.597 [Radio_Surface](INFO): Powering up
1970-01-14T21:14:59.662Z,1199699.662 [Power24vConverter](INFO): Powering up.
1970-01-14T21:14:59.737Z,1199699.737 [BuoyancyServo](DEBUG): Initializing EZServoServo.
1970-01-14T21:14:59.745Z,1199699.745 [BuoyancyServo](DEBUG): Initializing BuoyancyServo.
1970-01-14T21:14:59.746Z,1199699.746 [ElevatorServo](DEBUG): Initializing EZServoServo.
1970-01-14T21:14:59.753Z,1199699.753 [ElevatorServo](DEBUG): Initializing ElevatorServo.
1970-01-14T21:14:59.754Z,1199699.754 [MassServo](DEBUG): Initializing EZServoServo.
1970-01-14T21:14:59.761Z,1199699.761 [MassServo](DEBUG): Initializing MassServo.
1970-01-14T21:14:59.762Z,1199699.762 [RudderServo](DEBUG): Initializing EZServoServo.
1970-01-14T21:14:59.769Z,1199699.769 [RudderServo](DEBUG): Initializing RudderServo.
1970-01-14T21:14:59.770Z,1199699.770 [ThrusterHE](DEBUG): Initializing EZServoServo.
1970-01-14T21:14:59.777Z,1199699.777 [ThrusterHE](DEBUG): Initializing ThrusterHE.
1970-01-14T21:15:00.026Z,1199700.026 [DropWeight](CRITICAL): DROP WEIGHT MISSING.
1970-01-14T21:15:00.026Z,1199700.026 [DropWeight] Hardware Fault, FailCount= 1
1970-01-14T21:15:00.026Z,1199700.026 [DropWeight](ERROR): Hardware Fault
1970-01-14T21:15:00.096Z,1199700.096 [CommandExec](FAULT): Scheduling is paused
1970-01-14T21:15:00.097Z,1199700.097 [CBIT](INFO): Critical error at 19700114T211500
1970-01-14T21:15:00.097Z,1199700.097 [Supervisor](INFO): Stop Mission called by CBIT::checkCriticals
1970-01-14T21:15:00.099Z,1199700.099 [CBIT](ERROR): Hardware Fault in component: DropWeight
1970-01-14T21:15:00.100Z,1199700.100 [CBIT](CRITICAL): Hardware Fault in component: DropWeight
1970-01-14T21:15:00.506Z,1199700.506 [CBIT](INFO): Critical error at 19700114T211500
1970-01-14T21:15:02.807Z,1199702.807 [AHRS_M2](DEBUG): boresightMatrix m[ decimal 0 0 2 2 f0.0 f0.0 f-1.0 f0.0 f-1.0 f0.0 f-1.0 f0.0 f0.0 ]m set drop
1970-01-14T21:15:03.210Z,1199703.210 [AHRS_M2](DEBUG): chan0Format 2 set drop
1970-01-14T21:15:03.614Z,1199703.614 [AHRS_M2](DEBUG): chan0Trigger 5 set drop
1970-01-14T21:15:04.018Z,1199704.018 [AHRS_M2](DEBUG): chan0Enables array[ 0 15 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 0 ]array set drop
1970-01-14T21:15:04.018Z,1199704.018 [AHRS_M2](DEBUG): chan0EnableBit pitch dvid@ set drop
1970-01-14T21:15:04.422Z,1199704.422 [AHRS_M2](DEBUG): chan0EnableBit roll dvid@ set drop
1970-01-14T21:15:04.509Z,1199704.509 [WetLabsBB2FL] Communications Fault, FailCount= 1
1970-01-14T21:15:04.509Z,1199704.509 [WetLabsBB2FL](ERROR): Communications Fault
1970-01-14T21:15:04.826Z,1199704.826 [AHRS_M2](DEBUG): chan0EnableBit yaw dvid@ set drop
1970-01-14T21:15:04.900Z,1199704.900 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
1970-01-14T21:15:05.009Z,1199705.009 [WetLabsBB2FL](INFO): Powering down
1970-01-14T21:15:05.230Z,1199705.230 [AHRS_M2](DEBUG): chan0EnableBit magp dvid@ set drop
1970-01-14T21:15:05.414Z,1199705.414 [ThrusterHE](ERROR): Zero Speed Commanded.
1970-01-14T21:15:05.634Z,1199705.634 [AHRS_M2](DEBUG): chan0EnableBit accelp dvid@ set drop
1970-01-14T21:15:05.853Z,1199705.853 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
1970-01-14T21:15:05.853Z,1199705.853 [WetLabsBB2FL] No Fault, FailCount= 1
1970-01-14T21:15:06.038Z,1199706.038 [AHRS_M2](DEBUG): chan0EnableBit gyrop dvid@ set drop
1970-01-14T21:15:06.226Z,1199706.226 [WetLabsBB2FL](INFO): Powering up
1970-01-14T21:15:06.442Z,1199706.442 [AHRS_M2](DEBUG): chan0EnableBit yawErrEst dvid@ set drop
1970-01-14T21:15:06.846Z,1199706.846 [AHRS_M2](DEBUG): chan0EnableBit temperature dvid@ set drop
1970-01-14T21:15:06.854Z,1199706.854 [PNI_TCM](FAULT): Failed to set parameters during initialization.
1970-01-14T21:15:06.855Z,1199706.855 [PNI_TCM] Data Fault, FailCount= 1
1970-01-14T21:15:06.855Z,1199706.855 [PNI_TCM](ERROR): Data Fault
1970-01-14T21:15:06.918Z,1199706.918 [CBIT](ERROR): Data Fault in component: PNI_TCM
1970-01-14T21:15:07.251Z,1199707.251 [AHRS_M2](DEBUG): chan0EnableBit magBufferActiveIndex dvid@ set drop
1970-01-14T21:15:07.254Z,1199707.254 [PNI_TCM](INFO): Powering down
1970-01-14T21:15:07.654Z,1199707.654 [AHRS_M2](DEBUG): chan0TriggerDivisor 40 set drop
1970-01-14T21:15:08.521Z,1199708.521 [CBIT](INFO): Clearing failed state for component PNI_TCM
1970-01-14T21:15:08.521Z,1199708.521 [PNI_TCM] No Fault, FailCount= 1
1970-01-14T21:15:09.341Z,1199709.341 [CBIT](CRITICAL): Environmental Failure. Press:14.854256 PSI. Humidity:34%. Temp:25 C. ABORTING MISSION
1970-01-14T21:15:09.689Z,1199709.689 [Aanderaa_O2](FAULT): Failed to initialize within timeout.
1970-01-14T21:15:09.689Z,1199709.689 [Aanderaa_O2] Communications Fault, FailCount= 1
1970-01-14T21:15:09.689Z,1199709.689 [Aanderaa_O2](ERROR): Communications Fault
1970-01-14T21:15:09.791Z,1199709.791 [CBIT](INFO): Critical error at 19700114T211509
1970-01-14T21:15:09.794Z,1199709.794 [CBIT](ERROR): Communications Fault in component: Aanderaa_O2
1970-01-14T21:15:10.201Z,1199710.201 [Aanderaa_O2](INFO): Powering down
1970-01-14T21:15:10.973Z,1199710.973 [CBIT](INFO): Clearing failed state for component Aanderaa_O2
1970-01-14T21:15:10.973Z,1199710.973 [Aanderaa_O2] No Fault, FailCount= 1
1970-01-14T21:15:11.517Z,1199711.517 [WetLabsBB2FL] Communications Fault, FailCount= 2
1970-01-14T21:15:11.517Z,1199711.517 [WetLabsBB2FL](ERROR): Communications Fault
1970-01-14T21:15:11.762Z,1199711.762 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
1970-01-14T21:15:12.017Z,1199712.017 [WetLabsBB2FL](INFO): Powering down
1970-01-14T21:15:12.265Z,1199712.265 [CTD_Seabird](FAULT): Failed to initialize within timeout.
1970-01-14T21:15:12.265Z,1199712.265 [CTD_Seabird] Communications Fault, FailCount= 1
1970-01-14T21:15:12.265Z,1199712.265 [CTD_Seabird](ERROR): Communications Fault
1970-01-14T21:15:12.557Z,1199712.557 [CBIT](ERROR): Communications Fault in component: CTD_Seabird
1970-01-14T21:15:12.670Z,1199712.670 [CTD_Seabird](INFO): Powering down
1970-01-14T21:15:12.972Z,1199712.972 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
1970-01-14T21:15:12.972Z,1199712.972 [WetLabsBB2FL] No Fault, FailCount= 2
1970-01-14T21:15:13.230Z,1199713.230 [WetLabsBB2FL](INFO): Powering up
1970-01-14T21:15:13.769Z,1199713.769 [CBIT](INFO): Clearing failed state for component CTD_Seabird
1970-01-14T21:15:13.769Z,1199713.769 [CTD_Seabird] No Fault, FailCount= 1
1970-01-14T21:15:14.013Z,1199714.013 [CTD_Seabird](DEBUG): Initializing CTD_Seabird.
1970-01-14T21:15:16.142Z,1199716.142 [PNI_TCM](FAULT): Failed to set parameters during initialization.
1970-01-14T21:15:16.142Z,1199716.142 [PNI_TCM] Data Fault, FailCount= 2
1970-01-14T21:15:16.142Z,1199716.142 [PNI_TCM](ERROR): Data Fault
1970-01-14T21:15:16.223Z,1199716.223 [CBIT](ERROR): Data Fault in component: PNI_TCM
1970-01-14T21:15:16.546Z,1199716.546 [PNI_TCM](INFO): Powering down
1970-01-14T21:15:17.754Z,1199717.754 [AHRS_M2](FAULT): Failed to acquire valid data within timeout.
1970-01-14T21:15:17.754Z,1199717.754 [AHRS_M2] Data Fault, FailCount= 1
1970-01-14T21:15:17.754Z,1199717.754 [AHRS_M2](ERROR): Data Fault
1970-01-14T21:15:17.829Z,1199717.829 [CBIT](ERROR): Data Fault in component: AHRS_M2
1970-01-14T21:15:17.829Z,1199717.829 [CBIT](CRITICAL): Data Fault in component: AHRS_M2
1970-01-14T21:15:17.829Z,1199717.829 [CBIT](INFO): Clearing failed state for component PNI_TCM
1970-01-14T21:15:17.830Z,1199717.830 [PNI_TCM] No Fault, FailCount= 2
1970-01-14T21:15:18.235Z,1199718.235 [CBIT](INFO): Critical error at 19700114T211517
1970-01-14T21:15:18.521Z,1199718.521 [WetLabsBB2FL] Communications Fault, FailCount= 3
1970-01-14T21:15:18.521Z,1199718.521 [WetLabsBB2FL](ERROR): Communications Fault
1970-01-14T21:15:18.625Z,1199718.625 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
1970-01-14T21:15:19.021Z,1199719.021 [WetLabsBB2FL](INFO): Powering down
1970-01-14T21:15:19.858Z,1199719.858 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
1970-01-14T21:15:19.858Z,1199719.858 [WetLabsBB2FL] No Fault, FailCount= 3
1970-01-14T21:15:20.242Z,1199720.242 [WetLabsBB2FL](INFO): Powering up
1970-01-14T21:15:21.394Z,1199721.394 [Aanderaa_O2](FAULT): Failed to initialize within timeout.
1970-01-14T21:15:21.395Z,1199721.395 [Aanderaa_O2] Communications Fault, FailCount= 2
1970-01-14T21:15:21.395Z,1199721.395 [Aanderaa_O2](ERROR): Communications Fault
1970-01-14T21:15:21.473Z,1199721.473 [CBIT](ERROR): Communications Fault in component: Aanderaa_O2
1970-01-14T21:15:21.917Z,1199721.917 [Aanderaa_O2](INFO): Powering down
1970-01-14T21:15:22.693Z,1199722.693 [CBIT](INFO): Clearing failed state for component Aanderaa_O2
1970-01-14T21:15:22.693Z,1199722.693 [Aanderaa_O2] No Fault, FailCount= 2
1970-01-14T21:15:25.434Z,1199725.434 [PNI_TCM](FAULT): Failed to set parameters during initialization.
1970-01-14T21:15:25.434Z,1199725.434 [PNI_TCM] Data Fault, FailCount= 3
1970-01-14T21:15:25.434Z,1199725.434 [PNI_TCM](ERROR): Data Fault
1970-01-14T21:15:25.503Z,1199725.503 [CBIT](ERROR): Data Fault in component: PNI_TCM
1970-01-14T21:15:25.541Z,1199725.541 [WetLabsBB2FL] Communications Fault, FailCount= 4
1970-01-14T21:15:25.541Z,1199725.541 [WetLabsBB2FL](ERROR): Communications Fault
1970-01-14T21:15:25.838Z,1199725.838 [PNI_TCM](INFO): Powering down
1970-01-14T21:15:25.995Z,1199725.995 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
1970-01-14T21:15:26.044Z,1199726.044 [WetLabsBB2FL](INFO): Powering down
1970-01-14T21:15:27.065Z,1199727.065 [CTD_Seabird](FAULT): Failed to initialize within timeout.
1970-01-14T21:15:27.065Z,1199727.065 [CTD_Seabird] Communications Fault, FailCount= 2
1970-01-14T21:15:27.065Z,1199727.065 [CTD_Seabird](ERROR): Communications Fault
1970-01-14T21:15:27.108Z,1199727.108 [CBIT](INFO): Clearing failed state for component PNI_TCM
1970-01-14T21:15:27.108Z,1199727.108 [PNI_TCM] No Fault, FailCount= 3
1970-01-14T21:15:27.109Z,1199727.109 [CBIT](ERROR): Communications Fault in component: CTD_Seabird
1970-01-14T21:15:27.109Z,1199727.109 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL
1970-01-14T21:15:27.109Z,1199727.109 [WetLabsBB2FL] No Fault, FailCount= 4
1970-01-14T21:15:27.258Z,1199727.258 [WetLabsBB2FL](INFO): Powering up
1970-01-14T21:15:27.454Z,1199727.454 [NAL9602](INFO): Powering up NAL9602
1970-01-14T21:15:27.469Z,1199727.469 [CTD_Seabird](INFO): Powering down
1970-01-14T21:15:28.713Z,1199728.713 [CBIT](INFO): Clearing failed state for component CTD_Seabird
1970-01-14T21:15:28.713Z,1199728.713 [CTD_Seabird] No Fault, FailCount= 2
1970-01-14T21:15:28.813Z,1199728.813 [CTD_Seabird](DEBUG): Initializing CTD_Seabird.
1970-01-14T21:15:32.557Z,1199732.557 [WetLabsBB2FL] Communications Fault, FailCount= 5
1970-01-14T21:15:32.557Z,1199732.557 [WetLabsBB2FL](ERROR): Communications Fault
1970-01-14T21:15:32.751Z,1199732.751 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL
1970-01-14T21:15:32.751Z,1199732.751 [CBIT](FAULT): Communications Fault in component: WetLabsBB2FL
1970-01-14T21:15:33.057Z,1199733.057 [WetLabsBB2FL](INFO): Powering down
1970-01-14T21:15:33.115Z,1199733.114 [Aanderaa_O2](FAULT): Failed to initialize within timeout.
1970-01-14T21:15:33.115Z,1199733.115 [Aanderaa_O2] Communications Fault, FailCount= 3
1970-01-14T21:15:33.115Z,1199733.115 [Aanderaa_O2](ERROR): Communications Fault
1970-01-14T21:15:33.179Z,1199733.179 [CBIT](ERROR): Communications Fault in component: Aanderaa_O2
1970-01-14T21:15:33.180Z,1199733.180 [CBIT](FAULT): Communications Fault in component: Aanderaa_O2
1970-01-14T21:15:33.637Z,1199733.637 [Aanderaa_O2](INFO): Powering down
1970-01-14T21:15:34.730Z,1199734.730 [PNI_TCM](FAULT): Failed to set parameters during initialization.
1970-01-14T21:15:34.730Z,1199734.730 [PNI_TCM] Data Fault, FailCount= 4
1970-01-14T21:15:34.730Z,1199734.730 [PNI_TCM](ERROR): Data Fault
1970-01-14T21:15:34.798Z,1199734.798 [CBIT](ERROR): Data Fault in component: PNI_TCM
1970-01-14T21:15:35.131Z,1199735.131 [PNI_TCM](INFO): Powering down
1970-01-14T21:15:36.381Z,1199736.381 [CBIT](INFO): Clearing failed state for component PNI_TCM
1970-01-14T21:15:36.381Z,1199736.381 [PNI_TCM] No Fault, FailCount= 4
1970-01-14T21:15:38.366Z,1199738.366 [NAL9602](INFO): NAL9602 initialized
1970-01-14T21:15:41.869Z,1199741.869 [CTD_Seabird](FAULT): Failed to initialize within timeout.
1970-01-14T21:15:41.869Z,1199741.869 [CTD_Seabird] Communications Fault, FailCount= 3
1970-01-14T21:15:41.869Z,1199741.869 [CTD_Seabird](ERROR): Communications Fault
1970-01-14T21:15:42.069Z,1199742.069 [CBIT](ERROR): Communications Fault in component: CTD_Seabird
1970-01-14T21:15:42.070Z,1199742.070 [CBIT](FAULT): Communications Fault in component: CTD_Seabird
1970-01-14T21:15:42.273Z,1199742.273 [CTD_Seabird](INFO): Powering down
1970-01-14T21:15:44.023Z,1199744.023 [PNI_TCM](FAULT): Failed to set parameters during initialization.
1970-01-14T21:15:44.023Z,1199744.023 [PNI_TCM] Data Fault, FailCount= 5
1970-01-14T21:15:44.023Z,1199744.023 [PNI_TCM](ERROR): Data Fault
1970-01-14T21:15:44.088Z,1199744.088 [CBIT](ERROR): Data Fault in component: PNI_TCM
1970-01-14T21:15:44.088Z,1199744.088 [CBIT](CRITICAL): Data Fault in component: PNI_TCM
1970-01-14T21:15:44.424Z,1199744.424 [PNI_TCM](INFO): Powering down
1970-01-14T21:15:44.559Z,1199744.559 [CBIT](INFO): Critical error at 19700114T211544
1970-01-14T21:15:56.097Z,1199756.097 [CommandExec](IMPORTANT): got command quit
1970-01-14T21:15:57.101Z,1199757.101 [CommandExec ThreadHandler](INFO): Uninitializing protected caller thread.
1970-01-14T21:15:57.101Z,1199757.101 [CommandExec](INFO): Uninitializing the command executive.
1970-01-14T21:15:57.101Z,1199757.101 [CommandExec](INFO): Uninitializing the command scheduler.
1970-01-14T21:15:57.101Z,1199757.101 [CommandExec ThreadHandler](INFO): Thread cancelled.
1970-01-14T21:15:57.257Z,1199757.257 [Supervisor](DEBUG): Uninitializing supervisor and starting cleanup. Bye!
1970-01-14T21:15:57.257Z,1199757.257 [ComponentRegistry](INFO): Shutting down NavChartDb ThreadHandler
1970-01-14T21:15:57.257Z,1199757.257 [NavChartDb ThreadHandler](INFO): Thread cancelled.
1970-01-14T21:15:57.258Z,1199757.258 [NavChartDb](INFO): Join timeout helper Thread ID is 6317
1970-01-14T21:15:57.545Z,1199757.545 [NavChartDb ThreadHandler](INFO): Uninitializing protected caller thread.
1970-01-14T21:15:57.545Z,1199757.545 [NavChartDb ThreadHandler](INFO): Thread cancelled.
1970-01-14T21:15:57.557Z,1199757.557 [ComponentRegistry](INFO): Shutting down WetLabsBB2FL ThreadHandler
1970-01-14T21:15:57.557Z,1199757.557 [WetLabsBB2FL ThreadHandler](INFO): Thread cancelled.
1970-01-14T21:15:57.557Z,1199757.557 [WetLabsBB2FL](INFO): Join timeout helper Thread ID is 6318
1970-01-14T21:15:57.701Z,1199757.701 [WetLabsBB2FL ThreadHandler](INFO): Uninitializing protected caller thread.
1970-01-14T21:15:57.701Z,1199757.701 [WetLabsBB2FL](INFO): Powering down
1970-01-14T21:15:57.702Z,1199757.702 [WetLabsBB2FL ThreadHandler](INFO): Thread cancelled.
1970-01-14T21:15:57.717Z,1199757.717 [ComponentRegistry](INFO): Shutting down CTD_Seabird ThreadHandler
1970-01-14T21:15:57.717Z,1199757.717 [CTD_Seabird ThreadHandler](INFO): Thread cancelled.
1970-01-14T21:15:57.717Z,1199757.717 [CTD_Seabird](INFO): Join timeout helper Thread ID is 6319
1970-01-14T21:15:57.757Z,1199757.757 [CTD_Seabird ThreadHandler](INFO): Uninitializing protected caller thread.
1970-01-14T21:15:57.757Z,1199757.757 [CTD_Seabird](INFO): Powering down
1970-01-14T21:15:57.769Z,1199757.769 [CTD_Seabird ThreadHandler](INFO): Thread cancelled.
1970-01-14T21:15:57.777Z,1199757.777 [ComponentRegistry](INFO): Shutting down DAT ThreadHandler
1970-01-14T21:15:57.777Z,1199757.777 [DAT ThreadHandler](INFO): Thread cancelled.
1970-01-14T21:15:57.777Z,1199757.777 [DAT](INFO): Join timeout helper Thread ID is 6320
1970-01-14T21:15:57.957Z,1199757.957 [DAT](INFO): Powering down
1970-01-14T21:15:58.029Z,1199758.029 [DAT ThreadHandler](INFO): Uninitializing protected caller thread.
1970-01-14T21:15:58.029Z,1199758.029 [DAT](INFO): Powering down
1970-01-14T21:15:58.030Z,1199758.030 [DAT ThreadHandler](INFO): Thread cancelled.
1970-01-14T21:15:58.041Z,1199758.041 [ComponentRegistry](INFO): Shutting down Radio_Surface ThreadHandler
1970-01-14T21:15:58.041Z,1199758.041 [Radio_Surface ThreadHandler](INFO): Thread cancelled.
1970-01-14T21:15:58.041Z,1199758.041 [Radio_Surface](INFO): Join timeout helper Thread ID is 6321
1970-01-14T21:15:58.229Z,1199758.229 [Radio_Surface](INFO): Powering down
1970-01-14T21:15:58.230Z,1199758.230 [Radio_Surface ThreadHandler](INFO): Uninitializing protected caller thread.
1970-01-14T21:15:58.230Z,1199758.230 [Radio_Surface ThreadHandler](INFO): Thread cancelled.
1970-01-14T21:15:58.250Z,1199758.250 [ComponentRegistry](INFO): Shutting down Onboard ThreadHandler
1970-01-14T21:15:58.250Z,1199758.250 [Onboard ThreadHandler](INFO): Thread cancelled.
1970-01-14T21:15:58.250Z,1199758.250 [Onboard](INFO): Join timeout helper Thread ID is 6322
1970-01-14T21:15:59.221Z,1199759.221 [Onboard ThreadHandler](INFO): Uninitializing protected caller thread.
1970-01-14T21:15:59.221Z,1199759.221 [Onboard ThreadHandler](INFO): Thread cancelled.
1970-01-14T21:15:59.229Z,1199759.229 [ComponentRegistry](INFO): Shutting down DataOverHttps ThreadHandler
1970-01-14T21:15:59.229Z,1199759.229 [DataOverHttps ThreadHandler](INFO): Thread cancelled.
1970-01-14T21:15:59.230Z,1199759.230 [DataOverHttps](INFO): Join timeout helper Thread ID is 6323
1970-01-14T21:15:59.405Z,1199759.405 [DataOverHttps ThreadHandler](INFO): Uninitializing protected caller thread.
1970-01-14T21:15:59.406Z,1199759.406 [DataOverHttps ThreadHandler](INFO): Thread cancelled.
1970-01-14T21:15:59.422Z,1199759.422 [ComponentRegistry](INFO): Shutting down logger ThreadHandler
1970-01-14T21:15:59.422Z,1199759.422 [logger ThreadHandler](INFO): Thread cancelled.
1970-01-14T21:15:59.422Z,1199759.422 [logger](INFO): Join timeout helper Thread ID is 6324
1970-01-14T21:15:59.455Z,1199759.455 [logger ThreadHandler](INFO): Uninitializing protected caller thread.
1970-01-14T21:15:59.455Z,1199759.455 [logger ThreadHandler](INFO): Thread cancelled.
1970-01-14T21:15:59.461Z,1199759.461 [ComponentRegistry](INFO): Shutting down CommandLine ThreadHandler
1970-01-14T21:15:59.461Z,1199759.461 [CommandLine ThreadHandler](INFO): Thread cancelled.
1970-01-14T21:15:59.462Z,1199759.462 [CommandLine](INFO): Join timeout helper Thread ID is 6325
1970-01-14T21:15:59.505Z,1199759.505 [CommandLine ThreadHandler](INFO): Uninitializing protected caller thread.
1970-01-14T21:15:59.505Z,1199759.505 [CommandLine ThreadHandler](INFO): Thread cancelled.
1970-01-14T21:15:59.521Z,1199759.521 [ComponentRegistry](INFO): Shutting down CommandExec ThreadHandler
1970-01-14T21:15:59.522Z,1199759.522 [CommandExec ThreadHandler](INFO): Thread cancelled.
1970-01-14T21:15:59.522Z,1199759.522 [CommandExec](INFO): Join timeout helper Thread ID is 6326
1970-01-14T21:15:59.523Z,1199759.523 [ComponentRegistry](INFO): Shutting down controlThread ThreadHandler
1970-01-14T21:15:59.523Z,1199759.523 [controlThread ThreadHandler](INFO): Thread cancelled.
1970-01-14T21:15:59.524Z,1199759.524 [controlThread](INFO): Join timeout helper Thread ID is 6327
1970-01-14T21:15:59.765Z,1199759.765 [controlThread ThreadHandler](INFO): Uninitializing protected caller thread.
1970-01-14T21:15:59.765Z,1199759.765 [controlThread](DEBUG): Uninitializing ControlThread
1970-01-14T21:15:59.767Z,1199759.767 [NAL9602](INFO): Powering down
1970-01-14T21:15:59.768Z,1199759.768 [PNI_TCM](INFO): Powering down
1970-01-14T21:15:59.769Z,1199759.769 [Aanderaa_O2](INFO): Powering down
1970-01-14T21:15:59.771Z,1199759.771 [DepthRateCalculator](DEBUG): Uninitializing DepthRateCalculator.
1970-01-14T21:15:59.772Z,1199759.772 [ElevatorOffsetCalculator](DEBUG): Uninitializing ElevatorOffsetCalculator.
1970-01-14T21:15:59.772Z,1199759.772 [NavChart](DEBUG): Uninitialize NavChart Navigation.
1970-01-14T21:15:59.773Z,1199759.773 [MissionManager](INFO): Uninitializing Mission Default
1970-01-14T21:15:59.775Z,1199759.775 [MissionManager](INFO): Uninitializing Mission Startup
1970-01-14T21:15:59.776Z,1199759.776 [VerticalControl](DEBUG): Uninitialize VerticalControlComponent.
1970-01-14T21:15:59.777Z,1199759.777 [HorizontalControl](DEBUG): Uninitialize HorizontalControlComponent.
1970-01-14T21:15:59.777Z,1199759.777 [SpeedControl](DEBUG): Uninitialize SpeedControlComponent.
1970-01-14T21:15:59.777Z,1199759.777 [LoopControl](DEBUG): Uninitialize LoopControlComponent.
1970-01-14T21:15:59.777Z,1199759.777 [BuoyancyServo](DEBUG): Uninitialize Buoyancy Servo.
1970-01-14T21:15:59.778Z,1199759.778 [BuoyancyServo](INFO): Powering down
1970-01-14T21:15:59.789Z,1199759.789 [ElevatorServo](DEBUG): Uninitialize Elevator Servo.
1970-01-14T21:15:59.789Z,1199759.789 [ElevatorServo](INFO): Powering down
1970-01-14T21:15:59.790Z,1199759.790 [MassServo](DEBUG): Uninitialize Mass Servo.
1970-01-14T21:15:59.790Z,1199759.790 [MassServo](INFO): Powering down
1970-01-14T21:15:59.791Z,1199759.791 [RudderServo](DEBUG): Uninitialize Rudder Servo.
1970-01-14T21:15:59.791Z,1199759.791 [RudderServo](INFO): Powering down
1970-01-14T21:15:59.792Z,1199759.792 [ThrusterHE](DEBUG): Uninitialize Thruster Servo.
1970-01-14T21:15:59.792Z,1199759.792 [ThrusterHE](INFO): Powering down
1970-01-14T21:15:59.793Z,1199759.793 [SBIT](DEBUG): Uninitialize SBIT Component.
1970-01-14T21:15:59.793Z,1199759.793 [IBIT](DEBUG): Uninitialize IBIT Component.
1970-01-14T21:15:59.793Z,1199759.793 [CBIT](DEBUG): Uninitialize CBIT Component.
1970-01-14T21:15:59.793Z,1199759.793 [CBIT](DEBUG): Powering off loads.
1970-01-14T21:15:59.805Z,1199759.805 [CBIT](DEBUG): Disabling WDT.
1970-01-14T21:15:59.817Z,1199759.817 [CBIT](DEBUG): Opening all GF detection circuits.
1970-01-14T21:15:59.817Z,1199759.817 [controlThread ThreadHandler](INFO): Thread cancelled.
1970-01-14T21:15:59.826Z,1199759.826 [DAT ThreadHandler](INFO): Thread cancelled.
1970-01-14T21:15:59.831Z,1199759.831 [Radio_Surface ThreadHandler](INFO): Thread cancelled.
1970-01-14T21:15:59.835Z,1199759.835 [Onboard ThreadHandler](INFO): Thread cancelled.
1970-01-14T21:15:59.841Z,1199759.841 [DataOverHttps ThreadHandler](INFO): Thread cancelled.
1970-01-14T21:15:59.968Z,1199759.968 [WetLabsBB2FL ThreadHandler](INFO): Thread cancelled.
1970-01-14T21:15:59.973Z,1199759.973 [CTD_Seabird ThreadHandler](INFO): Thread cancelled.
1970-01-14T21:16:00.227Z,1199760.227 [NavChartDb ThreadHandler](INFO): Thread cancelled.
1970-01-14T21:16:00.284Z,1199760.284 [logger ThreadHandler](INFO): Thread cancelled.