2010-02-05T18:09:27.444Z,1265393367.444 [Supervisor](DEBUG): Initializing supervisor. 2010-02-05T18:09:27.448Z,1265393367.448 [SyncHandler](DEBUG): Created PCaller Thread at 404514E0 2010-02-05T18:09:27.449Z,1265393367.449 [SyncHandler](INFO): Protected caller Thread ID is 830 2010-02-05T18:09:27.449Z,1265393367.449 [ComponentRegistry](DEBUG): Component "controlThread" handled in its own thread. 2010-02-05T18:09:27.450Z,1265393367.450 [controlThread ThreadHandler](DEBUG): Created PCaller Thread at 404814E0 2010-02-05T18:09:27.450Z,1265393367.450 [controlThread ThreadHandler](INFO): Protected caller Thread ID is 831 2010-02-05T18:09:27.454Z,1265393367.454 [ComponentRegistry](DEBUG): SyncComponent "CycleStarter" handled in the control thread. 2010-02-05T18:09:27.473Z,1265393367.473 [ComponentRegistry](DEBUG): Component "CommandExec" handled in its own thread. 2010-02-05T18:09:27.474Z,1265393367.474 [CommandExec ThreadHandler](DEBUG): Created PCaller Thread at 404B14E0 2010-02-05T18:09:27.474Z,1265393367.474 [CommandExec ThreadHandler](INFO): Protected caller Thread ID is 832 2010-02-05T18:09:27.479Z,1265393367.479 [ComponentRegistry](DEBUG): Component "CommandLine" handled in its own thread. 2010-02-05T18:09:27.480Z,1265393367.480 [CommandLine ThreadHandler](DEBUG): Created PCaller Thread at 404E14E0 2010-02-05T18:09:27.480Z,1265393367.480 [CommandLine ThreadHandler](INFO): Protected caller Thread ID is 833 2010-02-05T18:09:27.482Z,1265393367.482 [ComponentRegistry](DEBUG): Component "logger" handled in its own thread. 2010-02-05T18:09:27.483Z,1265393367.483 [logger ThreadHandler](DEBUG): Created PCaller Thread at 405114E0 2010-02-05T18:09:27.484Z,1265393367.484 [logger ThreadHandler](INFO): Protected caller Thread ID is 834 2010-02-05T18:09:27.487Z,1265393367.487 [ComponentRegistry](DEBUG): SyncComponent "LogSplitter" handled in the control thread. 2010-02-05T18:09:27.488Z,1265393367.488 [Supervisor](INFO): Looking for Config files in directory: Config/ 2010-02-05T18:09:27.493Z,1265393367.493 [Supervisor](INFO): Opening Config file at: Config/secure.cfg 2010-02-05T18:09:27.592Z,1265393367.592 [ComponentRegistry](DEBUG): Loaded Config Component "Config/secure 2010-02-05T18:09:27.594Z,1265393367.594 [Supervisor](INFO): Opening Config file at: Config/Dock.cfg 2010-02-05T18:09:27.828Z,1265393367.828 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Dock 2010-02-05T18:09:27.830Z,1265393367.830 [Supervisor](INFO): Opening Config file at: Config/Navigation.cfg 2010-02-05T18:09:28.106Z,1265393368.106 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Navigation 2010-02-05T18:09:28.108Z,1265393368.108 [Supervisor](INFO): Opening Config file at: Config/Estimation.cfg 2010-02-05T18:09:28.218Z,1265393368.218 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Estimation 2010-02-05T18:09:28.220Z,1265393368.220 [Supervisor](INFO): Opening Config file at: Config/Sensor.cfg 2010-02-05T18:09:28.943Z,1265393368.943 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Sensor 2010-02-05T18:09:28.944Z,1265393368.944 [Supervisor](INFO): Opening Config file at: Config/vehicle.cfg 2010-02-05T18:09:29.454Z,1265393369.454 [ComponentRegistry](DEBUG): Loaded Config Component "Config/vehicle 2010-02-05T18:09:29.454Z,1265393369.454 [Supervisor](INFO): Opening Config file at: Config/Simulator.cfg 2010-02-05T18:09:29.978Z,1265393369.978 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Simulator 2010-02-05T18:09:29.979Z,1265393369.979 [Supervisor](INFO): Opening Config file at: Config/Servo.cfg 2010-02-05T18:09:30.410Z,1265393370.410 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Servo 2010-02-05T18:09:30.411Z,1265393370.411 [Supervisor](INFO): Opening Config file at: Config/Control.cfg 2010-02-05T18:09:30.768Z,1265393370.768 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Control 2010-02-05T18:09:30.768Z,1265393370.768 [Supervisor](INFO): Opening Config file at: Config/Science.cfg 2010-02-05T18:09:31.650Z,1265393371.650 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Science 2010-02-05T18:09:31.651Z,1265393371.651 [Supervisor](INFO): Opening Config file at: Config/Derivation.cfg 2010-02-05T18:09:31.889Z,1265393371.889 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Derivation 2010-02-05T18:09:31.890Z,1265393371.890 [Supervisor](INFO): Opening Config file at: Config/workSite.cfg 2010-02-05T18:09:32.034Z,1265393372.034 [ComponentRegistry](DEBUG): Loaded Config Component "Config/workSite 2010-02-05T18:09:32.036Z,1265393372.036 [Supervisor](INFO): Opening Config file at: Config/Guidance.cfg 2010-02-05T18:09:32.118Z,1265393372.118 [Supervisor](INFO): Opening Config file at: Config/Sample.cfg 2010-02-05T18:09:32.200Z,1265393372.200 [Supervisor](INFO): Opening Config file at: Config/logger.cfg 2010-02-05T18:09:32.406Z,1265393372.406 [ComponentRegistry](DEBUG): Loaded Config Component "Config/logger 2010-02-05T18:09:32.407Z,1265393372.407 [Supervisor](INFO): Opening Config file at: Config/BIT.cfg 2010-02-05T18:09:32.641Z,1265393372.641 [ComponentRegistry](DEBUG): Loaded Config Component "Config/BIT 2010-02-05T18:09:32.643Z,1265393372.643 [Supervisor](INFO): Looking for Config files in directory: Config/lrauv-makai/ 2010-02-05T18:09:32.647Z,1265393372.647 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/secure.cfg 2010-02-05T18:09:32.733Z,1265393372.733 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Battery.cfg 2010-02-05T18:09:33.001Z,1265393373.001 [ComponentRegistry](DEBUG): Loaded Config Component "Config/Battery 2010-02-05T18:09:33.002Z,1265393373.002 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Navigation.cfg 2010-02-05T18:09:33.104Z,1265393373.104 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Sensor.cfg 2010-02-05T18:09:33.274Z,1265393373.274 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/vehicle.cfg 2010-02-05T18:09:33.466Z,1265393373.466 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Simulator.cfg 2010-02-05T18:09:33.553Z,1265393373.553 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Servo.cfg 2010-02-05T18:09:33.668Z,1265393373.668 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Control.cfg 2010-02-05T18:09:33.777Z,1265393373.777 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/Science.cfg 2010-02-05T18:09:33.944Z,1265393373.944 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/logger.cfg 2010-02-05T18:09:34.046Z,1265393374.046 [Supervisor](INFO): Opening Config file at: Config/lrauv-makai/BIT.cfg 2010-02-05T18:09:34.147Z,1265393374.147 [Supervisor](FAULT): Ignoring configuration overrides from Data/persisted.cfg 2010-02-05T18:09:34.151Z,1265393374.151 [Module Loader](DEBUG): Loading Module at Modules/Simulator.so 2010-02-05T18:09:34.339Z,1265393374.339 [Module Loader](DEBUG): Loaded Module: Simulator (This is the module containing the Simulator) 2010-02-05T18:09:34.339Z,1265393374.339 [Module Loader](DEBUG): Loading Module at Modules/Servo.so 2010-02-05T18:09:34.525Z,1265393374.525 [BuoyancyServo] Loaded 2010-02-05T18:09:34.525Z,1265393374.525 [ComponentRegistry](DEBUG): SyncComponent "BuoyancyServo" handled in the control thread. 2010-02-05T18:09:34.546Z,1265393374.546 [ElevatorServo] Loaded 2010-02-05T18:09:34.547Z,1265393374.547 [ComponentRegistry](DEBUG): SyncComponent "ElevatorServo" handled in the control thread. 2010-02-05T18:09:34.567Z,1265393374.567 [MassServo] Loaded 2010-02-05T18:09:34.567Z,1265393374.567 [ComponentRegistry](DEBUG): SyncComponent "MassServo" handled in the control thread. 2010-02-05T18:09:34.588Z,1265393374.588 [RudderServo] Loaded 2010-02-05T18:09:34.588Z,1265393374.588 [ComponentRegistry](DEBUG): SyncComponent "RudderServo" handled in the control thread. 2010-02-05T18:09:34.604Z,1265393374.604 [ThrusterHE] Loaded 2010-02-05T18:09:34.604Z,1265393374.604 [ComponentRegistry](DEBUG): SyncComponent "ThrusterHE" handled in the control thread. 2010-02-05T18:09:34.605Z,1265393374.605 [Module Loader](DEBUG): Loaded Module: Servo (This is the module containing motor controllers) 2010-02-05T18:09:34.606Z,1265393374.606 [Module Loader](DEBUG): Loading Module at Modules/BIT.so 2010-02-05T18:09:34.777Z,1265393374.777 [SBIT](DEBUG): Construct Startup Built In Test. 2010-02-05T18:09:34.793Z,1265393374.793 [SBIT] Loaded 2010-02-05T18:09:34.793Z,1265393374.793 [ComponentRegistry](DEBUG): SyncComponent "SBIT" handled in the control thread. 2010-02-05T18:09:34.796Z,1265393374.796 [IBIT](DEBUG): Construct Initiated Built In Test. 2010-02-05T18:09:34.817Z,1265393374.817 [IBIT] Loaded 2010-02-05T18:09:34.817Z,1265393374.817 [ComponentRegistry](DEBUG): SyncComponent "IBIT" handled in the control thread. 2010-02-05T18:09:34.823Z,1265393374.823 [CBIT](DEBUG): Construct Continuous Built In Test. 2010-02-05T18:09:35.044Z,1265393375.044 [CBIT] Loaded 2010-02-05T18:09:35.045Z,1265393375.045 [ComponentRegistry](DEBUG): SyncComponent "CBIT" handled in the control thread. 2010-02-05T18:09:35.045Z,1265393375.045 [Module Loader](DEBUG): Loaded Module: BIT (Contains the BuiltInTest components, such as C Built In Test) 2010-02-05T18:09:35.047Z,1265393375.047 [Module Loader](DEBUG): Loading Module at Modules/Science.so 2010-02-05T18:09:35.262Z,1265393375.262 [CTD_Seabird] Loaded 2010-02-05T18:09:35.263Z,1265393375.263 [ComponentRegistry](DEBUG): Component "CTD_Seabird" handled in its own thread. 2010-02-05T18:09:35.264Z,1265393375.264 [CTD_Seabird ThreadHandler](DEBUG): Created PCaller Thread at 406644E0 2010-02-05T18:09:35.264Z,1265393375.264 [CTD_Seabird ThreadHandler](INFO): Protected caller Thread ID is 916 2010-02-05T18:09:35.297Z,1265393375.297 [ESPComponent] Loaded 2010-02-05T18:09:35.297Z,1265393375.297 [ComponentRegistry](DEBUG): SyncComponent "ESPComponent" handled in the control thread. 2010-02-05T18:09:35.317Z,1265393375.317 [PAR_Licor] Loaded 2010-02-05T18:09:35.317Z,1265393375.317 [ComponentRegistry](DEBUG): SyncComponent "PAR_Licor" handled in the control thread. 2010-02-05T18:09:35.348Z,1265393375.348 [WetLabsBB2FL] Loaded 2010-02-05T18:09:35.348Z,1265393375.348 [ComponentRegistry](DEBUG): Component "WetLabsBB2FL" handled in its own thread. 2010-02-05T18:09:35.350Z,1265393375.350 [WetLabsBB2FL ThreadHandler](DEBUG): Created PCaller Thread at 406944E0 2010-02-05T18:09:35.350Z,1265393375.350 [WetLabsBB2FL ThreadHandler](INFO): Protected caller Thread ID is 917 2010-02-05T18:09:35.351Z,1265393375.351 [Module Loader](DEBUG): Loaded Module: Science (Contains the science components) 2010-02-05T18:09:35.351Z,1265393375.351 [Module Loader](DEBUG): Loading Module at Modules/Derivation.so 2010-02-05T18:09:35.456Z,1265393375.456 [DepthRateCalculator] Loaded 2010-02-05T18:09:35.456Z,1265393375.456 [ComponentRegistry](DEBUG): SyncComponent "DepthRateCalculator" handled in the control thread. 2010-02-05T18:09:35.462Z,1265393375.462 [PitchRateCalculator] Loaded 2010-02-05T18:09:35.462Z,1265393375.462 [ComponentRegistry](DEBUG): SyncComponent "PitchRateCalculator" handled in the control thread. 2010-02-05T18:09:35.472Z,1265393375.472 [SpeedCalculator] Loaded 2010-02-05T18:09:35.472Z,1265393375.472 [ComponentRegistry](DEBUG): SyncComponent "SpeedCalculator" handled in the control thread. 2010-02-05T18:09:35.477Z,1265393375.477 [YawRateCalculator] Loaded 2010-02-05T18:09:35.478Z,1265393375.478 [ComponentRegistry](DEBUG): SyncComponent "YawRateCalculator" handled in the control thread. 2010-02-05T18:09:35.497Z,1265393375.497 [ElevatorOffsetCalculator] Loaded 2010-02-05T18:09:35.497Z,1265393375.497 [ComponentRegistry](DEBUG): SyncComponent "ElevatorOffsetCalculator" handled in the control thread. 2010-02-05T18:09:35.498Z,1265393375.498 [Module Loader](DEBUG): Loaded Module: Derivation (Contains the base derivation components) 2010-02-05T18:09:35.499Z,1265393375.499 [Module Loader](DEBUG): Loading Module at Modules/Dock.so 2010-02-05T18:09:35.624Z,1265393375.624 [Module Loader](DEBUG): Loaded Module: Dock (Contains behaviors and commands for docking) 2010-02-05T18:09:35.625Z,1265393375.625 [Module Loader](DEBUG): Loading Module at Modules/Trigger.so 2010-02-05T18:09:35.668Z,1265393375.668 [Module Loader](DEBUG): Loaded Module: Trigger (Contains triggers for use in missions) 2010-02-05T18:09:35.668Z,1265393375.668 [Module Loader](DEBUG): Loading Module at Modules/Navigation.so 2010-02-05T18:09:35.808Z,1265393375.808 [DeadReckonUsingMultipleVelocitySources] Loaded 2010-02-05T18:09:35.809Z,1265393375.809 [ComponentRegistry](DEBUG): SyncComponent "DeadReckonUsingMultipleVelocitySources" handled in the control thread. 2010-02-05T18:09:35.823Z,1265393375.823 [NavChart] Loaded 2010-02-05T18:09:35.823Z,1265393375.823 [ComponentRegistry](DEBUG): SyncComponent "NavChart" handled in the control thread. 2010-02-05T18:09:35.829Z,1265393375.829 [UniversalFixResidualReporter] Loaded 2010-02-05T18:09:35.829Z,1265393375.829 [ComponentRegistry](DEBUG): SyncComponent "UniversalFixResidualReporter" handled in the control thread. 2010-02-05T18:09:35.830Z,1265393375.830 [Module Loader](DEBUG): Loaded Module: Navigation (Contains the base navigation components) 2010-02-05T18:09:35.830Z,1265393375.830 [Module Loader](DEBUG): Loading Module at Modules/Sensor.so 2010-02-05T18:09:37.213Z,1265393377.213 [AHRS_M2] Loaded 2010-02-05T18:09:37.214Z,1265393377.214 [ComponentRegistry](DEBUG): SyncComponent "AHRS_M2" handled in the control thread. 2010-02-05T18:09:37.462Z,1265393377.462 [BackseatComponent] Loaded 2010-02-05T18:09:37.463Z,1265393377.463 [ComponentRegistry](DEBUG): Component "BackseatComponent" handled in its own thread. 2010-02-05T18:09:37.464Z,1265393377.464 [BackseatComponent ThreadHandler](DEBUG): Created PCaller Thread at 40A244E0 2010-02-05T18:09:37.464Z,1265393377.464 [BackseatComponent ThreadHandler](INFO): Protected caller Thread ID is 918 2010-02-05T18:09:37.467Z,1265393377.467 [LcmUniversalReporter] Loaded 2010-02-05T18:09:37.467Z,1265393377.467 [ComponentRegistry](DEBUG): SyncComponent "LcmUniversalReporter" handled in the control thread. 2010-02-05T18:09:38.202Z,1265393378.202 [BPC1] Loaded 2010-02-05T18:09:38.202Z,1265393378.202 [ComponentRegistry](DEBUG): SyncComponent "BPC1" handled in the control thread. 2010-02-05T18:09:38.349Z,1265393378.349 [DataOverHttps] Loaded 2010-02-05T18:09:38.349Z,1265393378.349 [ComponentRegistry](DEBUG): Component "DataOverHttps" handled in its own thread. 2010-02-05T18:09:38.350Z,1265393378.350 [DataOverHttps ThreadHandler](DEBUG): Created PCaller Thread at 40A544E0 2010-02-05T18:09:38.350Z,1265393378.350 [DataOverHttps ThreadHandler](INFO): Protected caller Thread ID is 919 2010-02-05T18:09:38.372Z,1265393378.372 [Depth_Keller] Loaded 2010-02-05T18:09:38.372Z,1265393378.372 [ComponentRegistry](DEBUG): SyncComponent "Depth_Keller" handled in the control thread. 2010-02-05T18:09:38.377Z,1265393378.377 [DropWeight] Loaded 2010-02-05T18:09:38.377Z,1265393378.377 [ComponentRegistry](DEBUG): SyncComponent "DropWeight" handled in the control thread. 2010-02-05T18:09:38.416Z,1265393378.416 [DVL_micro] Loaded 2010-02-05T18:09:38.416Z,1265393378.416 [ComponentRegistry](DEBUG): SyncComponent "DVL_micro" handled in the control thread. 2010-02-05T18:09:38.477Z,1265393378.477 [NAL9602] Loaded 2010-02-05T18:09:38.477Z,1265393378.477 [ComponentRegistry](DEBUG): SyncComponent "NAL9602" handled in the control thread. 2010-02-05T18:09:38.504Z,1265393378.504 [Onboard] Loaded 2010-02-05T18:09:38.504Z,1265393378.504 [ComponentRegistry](DEBUG): Component "Onboard" handled in its own thread. 2010-02-05T18:09:38.505Z,1265393378.505 [Onboard ThreadHandler](DEBUG): Created PCaller Thread at 40A844E0 2010-02-05T18:09:38.506Z,1265393378.506 [Onboard ThreadHandler](INFO): Protected caller Thread ID is 920 2010-02-05T18:09:38.518Z,1265393378.518 [Power24vConverter] Loaded 2010-02-05T18:09:38.518Z,1265393378.518 [ComponentRegistry](DEBUG): SyncComponent "Power24vConverter" handled in the control thread. 2010-02-05T18:09:38.533Z,1265393378.533 [Radio_Surface] Loaded 2010-02-05T18:09:38.533Z,1265393378.533 [ComponentRegistry](DEBUG): Component "Radio_Surface" handled in its own thread. 2010-02-05T18:09:38.534Z,1265393378.534 [Radio_Surface ThreadHandler](DEBUG): Created PCaller Thread at 40AB44E0 2010-02-05T18:09:38.534Z,1265393378.534 [Radio_Surface ThreadHandler](INFO): Protected caller Thread ID is 921 2010-02-05T18:09:38.629Z,1265393378.629 [DAT] Loaded 2010-02-05T18:09:38.629Z,1265393378.629 [ComponentRegistry](DEBUG): Component "DAT" handled in its own thread. 2010-02-05T18:09:38.630Z,1265393378.630 [DAT ThreadHandler](DEBUG): Created PCaller Thread at 40AE44E0 2010-02-05T18:09:38.630Z,1265393378.630 [DAT ThreadHandler](INFO): Protected caller Thread ID is 922 2010-02-05T18:09:38.631Z,1265393378.631 [Module Loader](DEBUG): Loaded Module: Sensor (Contains the sensor components) 2010-02-05T18:09:38.632Z,1265393378.632 [Module Loader](DEBUG): Loading Module at Modules/Estimation.so 2010-02-05T18:09:38.715Z,1265393378.715 [Module Loader](DEBUG): Loaded Module: Estimation (Contains the base estimation components) 2010-02-05T18:09:38.717Z,1265393378.717 [Module Loader](DEBUG): Loading Module at Modules/Control.so 2010-02-05T18:09:38.787Z,1265393378.787 [VerticalControl](DEBUG): Construct VerticalControl. 2010-02-05T18:09:38.838Z,1265393378.838 [VerticalControl] Loaded 2010-02-05T18:09:38.839Z,1265393378.839 [ComponentRegistry](DEBUG): SyncComponent "VerticalControl" handled in the control thread. 2010-02-05T18:09:38.842Z,1265393378.842 [HorizontalControl](DEBUG): Construct HorizontalControl. 2010-02-05T18:09:38.880Z,1265393378.880 [HorizontalControl] Loaded 2010-02-05T18:09:38.880Z,1265393378.880 [ComponentRegistry](DEBUG): SyncComponent "HorizontalControl" handled in the control thread. 2010-02-05T18:09:38.883Z,1265393378.883 [SpeedControl](DEBUG): Construct SpeedControl. 2010-02-05T18:09:38.884Z,1265393378.884 [SpeedControl] Loaded 2010-02-05T18:09:38.885Z,1265393378.885 [ComponentRegistry](DEBUG): SyncComponent "SpeedControl" handled in the control thread. 2010-02-05T18:09:38.888Z,1265393378.888 [LoopControl](DEBUG): Construct LoopControl. 2010-02-05T18:09:38.888Z,1265393378.888 [LoopControl] Loaded 2010-02-05T18:09:38.888Z,1265393378.888 [ComponentRegistry](DEBUG): SyncComponent "LoopControl" handled in the control thread. 2010-02-05T18:09:38.889Z,1265393378.889 [Module Loader](DEBUG): Loaded Module: Control (Contains the Control components, such as Depth, Heading, and Speed Control) 2010-02-05T18:09:38.889Z,1265393378.889 [Module Loader](DEBUG): Loading Module at Modules/Sample.so 2010-02-05T18:09:38.905Z,1265393378.905 [Module Loader](DEBUG): Loaded Module: Sample (This is a Sample Module of Sample Components) 2010-02-05T18:09:38.906Z,1265393378.906 [Module Loader](DEBUG): Loading Module at Modules/Guidance.so 2010-02-05T18:09:39.270Z,1265393379.270 [Module Loader](DEBUG): Loaded Module: Guidance (Contains behaviors and commands) 2010-02-05T18:09:39.276Z,1265393379.276 [ComponentRegistry](DEBUG): SyncComponent "MissionManager" handled in the control thread. 2010-02-05T18:09:39.279Z,1265393379.279 [ComponentRegistry](DEBUG): SyncComponent "Reporter" handled in the control thread. 2010-02-05T18:09:39.290Z,1265393379.290 [ComponentRegistry](DEBUG): Component "NavChartDb" handled in its own thread. 2010-02-05T18:09:39.292Z,1265393379.292 [NavChartDb ThreadHandler](DEBUG): Created PCaller Thread at 40BDE4E0 2010-02-05T18:09:39.292Z,1265393379.292 [NavChartDb ThreadHandler](INFO): Protected caller Thread ID is 923 2010-02-05T18:09:39.297Z,1265393379.297 [Supervisor](INFO): Main Thread ID is 825 2010-02-05T18:09:39.297Z,1265393379.297 [Supervisor](DEBUG): Running supervisor. 2010-02-05T18:09:39.297Z,1265393379.297 [CommandExec ThreadHandler](INFO): Handler Thread ID is 924 2010-02-05T18:09:39.298Z,1265393379.298 [CommandExec](INFO): Initializing the command executive. 2010-02-05T18:09:39.299Z,1265393379.299 [CommandLine ThreadHandler](INFO): Handler Thread ID is 925 2010-02-05T18:09:39.301Z,1265393379.301 [controlThread ThreadHandler](INFO): Handler Thread ID is 926 2010-02-05T18:09:39.302Z,1265393379.302 [controlThread](DEBUG): Initializing ControlThread 2010-02-05T18:09:39.304Z,1265393379.304 [SBIT](INFO): Initialize SBIT Component. 2010-02-05T18:09:39.304Z,1265393379.304 [SBIT](IMPORTANT): git: 2023-04-04 2010-02-05T18:09:39.304Z,1265393379.304 [SBIT](INFO): git hash: b8e3dc7784c205eaa6d34dbcc6cfad52b0792170 2010-02-05T18:09:39.305Z,1265393379.305 [SBIT](IMPORTANT): Kernel Release: 2.6.27.8 2010-02-05T18:09:39.306Z,1265393379.306 [SBIT](INFO): Kernel Reporting Different Version From Configuration. Kernel Expected: #2 PREEMPT Thu Jan 11 20:13:48 PST 2018 Kernel Reported: #1 PREEMPT Wed Mar 17 08:23:48 PDT 2021 2010-02-05T18:09:39.307Z,1265393379.307 [SBIT](INFO): Beginning SBIT in 59.000000 seconds. 2010-02-05T18:09:39.308Z,1265393379.308 [IBIT](INFO): Initialize IBIT Component. 2010-02-05T18:09:39.308Z,1265393379.308 [CBIT](DEBUG): Initialize CBIT Component. 2010-02-05T18:09:39.309Z,1265393379.309 [logger ThreadHandler](INFO): Handler Thread ID is 927 2010-02-05T18:09:39.323Z,1265393379.323 [CBIT](DEBUG): Initialized mux pins. 2010-02-05T18:09:39.323Z,1265393379.323 [CBIT](FAULT): LAST RESTART WAS UNINTENTIONAL. 2010-02-05T18:09:39.323Z,1265393379.323 [CBIT](DEBUG): Initializing the watchdog timer. 2010-02-05T18:09:39.335Z,1265393379.335 [CTD_Seabird ThreadHandler](INFO): Handler Thread ID is 928 2010-02-05T18:09:39.336Z,1265393379.336 [CTD_Seabird](DEBUG): Initializing CTD_Seabird. 2010-02-05T18:09:39.340Z,1265393379.340 [WetLabsBB2FL ThreadHandler](INFO): Handler Thread ID is 930 2010-02-05T18:09:39.343Z,1265393379.343 [WetLabsBB2FL](INFO): Powering up 2010-02-05T18:09:39.345Z,1265393379.345 [BackseatComponent ThreadHandler](INFO): Handler Thread ID is 932 2010-02-05T18:09:39.347Z,1265393379.347 [CBIT](CRITICAL): LAST REBOOT DUE TO WATCHDOG TIMER RESET. 2010-02-05T18:09:39.347Z,1265393379.347 [CBIT](DEBUG): Initializing heartbeat. 2010-02-05T18:09:39.361Z,1265393379.361 [DataOverHttps ThreadHandler](INFO): Handler Thread ID is 933 2010-02-05T18:09:39.362Z,1265393379.362 [DataOverHttps](DEBUG): dashIP=134.89.2.23 starts with a digit so assuming it is a numeric IP 2010-02-05T18:09:39.375Z,1265393379.375 [Onboard ThreadHandler](INFO): Handler Thread ID is 934 2010-02-05T18:09:39.393Z,1265393379.393 [Radio_Surface ThreadHandler](INFO): Handler Thread ID is 935 2010-02-05T18:09:39.415Z,1265393379.415 [DAT ThreadHandler](INFO): Handler Thread ID is 936 2010-02-05T18:09:39.419Z,1265393379.419 [CBIT](DEBUG): Deactivating GF circuits. 2010-02-05T18:09:39.419Z,1265393379.419 [CBIT](DEBUG): Deactivating emergency mode. 2010-02-05T18:09:39.420Z,1265393379.420 [DAT](INFO): Powering up 2010-02-05T18:09:39.420Z,1265393379.420 [DAT](DEBUG): Initializing DAT. 2010-02-05T18:09:39.423Z,1265393379.423 [NavChartDb ThreadHandler](INFO): Handler Thread ID is 938 2010-02-05T18:09:39.432Z,1265393379.432 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US1WC07M.000 2010-02-05T18:09:39.432Z,1265393379.432 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US1WC07M.000 2010-02-05T18:09:39.432Z,1265393379.432 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US2WC11M.000 2010-02-05T18:09:39.432Z,1265393379.432 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US2WC11M.000 2010-02-05T18:09:39.432Z,1265393379.432 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US3CA52M.000 2010-02-05T18:09:39.433Z,1265393379.433 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US3CA52M.000 2010-02-05T18:09:39.433Z,1265393379.433 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US5CA50M.000 2010-02-05T18:09:39.433Z,1265393379.433 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US5CA50M.000 2010-02-05T18:09:39.433Z,1265393379.433 [NavChartDb](INFO): Looking for Electronic Nav Chart file at: Resources/ElectronicNavigationCharts/US3CA69M.000 2010-02-05T18:09:39.433Z,1265393379.433 [NavChartDb](INFO): Already Loaded Electronic Nav Chart data from US3CA69M.000 2010-02-05T18:09:39.459Z,1265393379.459 [CBIT](DEBUG): Backplane powered. 2010-02-05T18:09:39.463Z,1265393379.463 [DepthRateCalculator](DEBUG): Initializing DepthRateCalculator. 2010-02-05T18:09:39.464Z,1265393379.464 [PitchRateCalculator](DEBUG): Initializing PitchRateCalculator. 2010-02-05T18:09:39.464Z,1265393379.464 [SpeedCalculator](DEBUG): Initializing SpeedCalculator. 2010-02-05T18:09:39.464Z,1265393379.464 [YawRateCalculator](DEBUG): Initializing YawRateCalculator. 2010-02-05T18:09:39.465Z,1265393379.465 [ElevatorOffsetCalculator](DEBUG): Initializing ElevatorOffsetCalculator. 2010-02-05T18:09:39.466Z,1265393379.466 [NavChart](DEBUG): Initialize NavChart Navigation. 2010-02-05T18:09:39.466Z,1265393379.466 [UniversalFixResidualReporter](DEBUG): Initializing UniversalFixResidualReporter component. 2010-02-05T18:09:39.473Z,1265393379.473 [VerticalControl](DEBUG): Initialize VerticalControlComponent. 2010-02-05T18:09:39.479Z,1265393379.479 [HorizontalControl](DEBUG): Initialize HorizontalControlComponent. 2010-02-05T18:09:39.480Z,1265393379.480 [SpeedControl](DEBUG): Initialize SpeedControlComponent. 2010-02-05T18:09:39.480Z,1265393379.480 [LoopControl](DEBUG): Initialize LoopControlComponent. 2010-02-05T18:09:39.481Z,1265393379.481 [MissionManager](INFO): Loading Mission from file: Missions/Startup.xml 2010-02-05T18:09:39.529Z,1265393379.529 [Startup:A.GoToSurface](DEBUG): Construct GoToSurface. 2010-02-05T18:09:39.574Z,1265393379.574 [MissionManager](DEBUG): 2010-02-05T18:09:39.574Z,1265393379.574 [MissionManager](INFO): Loading Mission from file: Missions/Default.xml 2010-02-05T18:09:39.645Z,1265393379.645 [MissionManager](INFO): DefineArg Default.ElapsedSinceDefaultStarted = 0.000000 min 2010-02-05T18:09:39.646Z,1265393379.646 [Default:A.Wait](DEBUG): Construct Wait. 2010-02-05T18:09:39.664Z,1265393379.664 [Default:B.GoToSurface](DEBUG): Construct GoToSurface. 2010-02-05T18:09:39.691Z,1265393379.691 [Default:CheckIn:Read_Iridium:A_Timeout:A.Execute](DEBUG): Construct Execute. 2010-02-05T18:09:39.694Z,1265393379.694 [Default:CheckIn:C.Wait](DEBUG): Construct Wait. 2010-02-05T18:09:39.716Z,1265393379.716 [Default:E.Execute](DEBUG): Construct Execute. 2010-02-05T18:09:39.735Z,1265393379.735 [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 2010-02-05T18:09:39.740Z,1265393379.740 [controlThread](DEBUG): Component order: CycleStarter,ESPComponent,PAR_Licor,AHRS_M2,BPC1,Depth_Keller,DropWeight,DVL_micro,NAL9602,Power24vConverter,PAR_Licor,Depth_Keller,DepthRateCalculator,PitchRateCalculator,SpeedCalculator,YawRateCalculator,ElevatorOffsetCalculator,DeadReckonUsingMultipleVelocitySources,NavChart,UniversalFixResidualReporter,MissionManager,VerticalControl,HorizontalControl,SpeedControl,LoopControl,BuoyancyServo,ElevatorServo,MassServo,RudderServo,ThrusterHE,SBIT,IBIT,CBIT,LcmUniversalReporter,Reporter,LogSplitter, 2010-02-05T18:09:39.753Z,1265393379.753 [AHRS_M2](DEBUG): Initializing AHRS_M2. 2010-02-05T18:09:39.799Z,1265393379.799 [Radio_Surface](INFO): Powering up 2010-02-05T18:09:39.920Z,1265393379.920 [Depth_Keller](ERROR): Pressure or depth reading out of range: 1895.444336 decibar, 0.000000 m 2010-02-05T18:09:39.928Z,1265393379.928 [Power24vConverter](INFO): Powering up. 2010-02-05T18:09:39.971Z,1265393379.971 [DepthRateCalculator](ERROR): Depth measurement is not active 2010-02-05T18:09:39.000Z,1265393380.000 [BuoyancyServo](DEBUG): Initializing EZServoServo. 2010-02-05T18:09:40.007Z,1265393380.007 [BuoyancyServo](DEBUG): Initializing BuoyancyServo. 2010-02-05T18:09:40.008Z,1265393380.008 [ElevatorServo](DEBUG): Initializing EZServoServo. 2010-02-05T18:09:40.015Z,1265393380.015 [ElevatorServo](DEBUG): Initializing ElevatorServo. 2010-02-05T18:09:40.016Z,1265393380.016 [MassServo](DEBUG): Initializing EZServoServo. 2010-02-05T18:09:40.024Z,1265393380.024 [MassServo](DEBUG): Initializing MassServo. 2010-02-05T18:09:40.025Z,1265393380.025 [RudderServo](DEBUG): Initializing EZServoServo. 2010-02-05T18:09:40.031Z,1265393380.031 [RudderServo](DEBUG): Initializing RudderServo. 2010-02-05T18:09:40.032Z,1265393380.032 [ThrusterHE](DEBUG): Initializing EZServoServo. 2010-02-05T18:09:40.039Z,1265393380.039 [ThrusterHE](DEBUG): Initializing ThrusterHE. 2010-02-05T18:09:40.041Z,1265393380.041 [CommandExec](FAULT): Scheduling is paused 2010-02-05T18:09:40.042Z,1265393380.042 [CBIT](INFO): Critical error at 20100205T180939 2010-02-05T18:09:40.042Z,1265393380.042 [Supervisor](INFO): Stop Mission called by CBIT::checkCriticals 2010-02-05T18:09:40.213Z,1265393380.213 [DropWeight](CRITICAL): DROP WEIGHT MISSING. 2010-02-05T18:09:40.213Z,1265393380.213 [DropWeight] Hardware Fault, FailCount= 1 2010-02-05T18:09:40.213Z,1265393380.213 [DropWeight](ERROR): Hardware Fault 2010-02-05T18:09:40.252Z,1265393380.252 [CBIT](INFO): Critical error at 20100205T180940 2010-02-05T18:09:40.263Z,1265393380.263 [CBIT](ERROR): Hardware Fault in component: DropWeight 2010-02-05T18:09:40.263Z,1265393380.263 [CBIT](CRITICAL): Hardware Fault in component: DropWeight 2010-02-05T18:09:40.577Z,1265393380.577 [CBIT](INFO): Critical error at 20100205T180940 2010-02-05T18:09:43.303Z,1265393383.303 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:09:43.731Z,1265393383.731 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:09:44.219Z,1265393384.219 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:09:44.647Z,1265393384.647 [WetLabsBB2FL] Communications Fault, FailCount= 1 2010-02-05T18:09:44.647Z,1265393384.647 [WetLabsBB2FL](ERROR): Communications Fault 2010-02-05T18:09:44.675Z,1265393384.675 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:09:44.800Z,1265393384.800 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL 2010-02-05T18:09:45.131Z,1265393385.131 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:09:45.147Z,1265393385.147 [WetLabsBB2FL](INFO): Powering down 2010-02-05T18:09:45.595Z,1265393385.595 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:09:45.716Z,1265393385.716 [ThrusterHE](ERROR): Zero Speed Commanded. 2010-02-05T18:09:46.111Z,1265393386.111 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:09:46.562Z,1265393386.562 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL 2010-02-05T18:09:46.563Z,1265393386.563 [WetLabsBB2FL] No Fault, FailCount= 1 2010-02-05T18:09:46.764Z,1265393386.764 [WetLabsBB2FL](INFO): Powering up 2010-02-05T18:09:46.899Z,1265393386.899 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:09:47.323Z,1265393387.323 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:09:47.755Z,1265393387.755 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:09:48.175Z,1265393388.175 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:09:48.611Z,1265393388.611 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:09:49.007Z,1265393389.007 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:09:49.427Z,1265393389.427 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:09:49.847Z,1265393389.847 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:09:50.255Z,1265393390.255 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:09:50.667Z,1265393390.667 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:09:51.135Z,1265393391.135 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:09:51.266Z,1265393391.266 [DAT](INFO): DAT read: 2010-02-05T18:09:51.274Z,1265393391.274 [DAT](INFO): DAT read: Teledyne Benthos DAT-900 Series 2010-02-05T18:09:51.567Z,1265393391.567 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:09:52.003Z,1265393392.003 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:09:52.055Z,1265393392.055 [WetLabsBB2FL] Communications Fault, FailCount= 2 2010-02-05T18:09:52.055Z,1265393392.055 [WetLabsBB2FL](ERROR): Communications Fault 2010-02-05T18:09:52.387Z,1265393392.387 [CTD_Seabird](FAULT): Failed to initialize within timeout. 2010-02-05T18:09:52.387Z,1265393392.387 [CTD_Seabird] Communications Fault, FailCount= 1 2010-02-05T18:09:52.387Z,1265393392.387 [CTD_Seabird](ERROR): Communications Fault 2010-02-05T18:09:52.415Z,1265393392.415 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:09:52.480Z,1265393392.480 [CBIT](ERROR): Communications Fault in component: CTD_Seabird 2010-02-05T18:09:52.480Z,1265393392.480 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL 2010-02-05T18:09:52.555Z,1265393392.555 [WetLabsBB2FL](INFO): Powering down 2010-02-05T18:09:52.776Z,1265393392.776 [DAT](INFO): DAT read: MF Frequency Band 2010-02-05T18:09:52.777Z,1265393392.777 [DAT](INFO): DAT read: Directional Acoustic Transponder version 8.15.0 2010-02-05T18:09:52.778Z,1265393392.778 [DAT](INFO): DAT read: Feb 5 2010 18:09:46 2010-02-05T18:09:52.792Z,1265393392.792 [CTD_Seabird](INFO): Powering down 2010-02-05T18:09:52.815Z,1265393392.815 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:09:52.815Z,1265393392.815 [AHRS_M2](FAULT): Failed to initialize within timeout. 2010-02-05T18:09:52.815Z,1265393392.815 [AHRS_M2] Communications Fault, FailCount= 1 2010-02-05T18:09:52.815Z,1265393392.815 [AHRS_M2](ERROR): Communications Fault 2010-02-05T18:09:52.879Z,1265393392.879 [CBIT](ERROR): Communications Fault in component: AHRS_M2 2010-02-05T18:09:52.912Z,1265393392.912 [AHRS_M2](INFO): Powering down 2010-02-05T18:09:53.763Z,1265393393.763 [CBIT](INFO): Clearing failed state for component CTD_Seabird 2010-02-05T18:09:53.763Z,1265393393.763 [CTD_Seabird] No Fault, FailCount= 1 2010-02-05T18:09:53.764Z,1265393393.764 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL 2010-02-05T18:09:53.764Z,1265393393.764 [WetLabsBB2FL] No Fault, FailCount= 2 2010-02-05T18:09:53.764Z,1265393393.764 [CBIT](INFO): Clearing failed state for component AHRS_M2 2010-02-05T18:09:53.764Z,1265393393.764 [AHRS_M2] No Fault, FailCount= 1 2010-02-05T18:09:53.768Z,1265393393.768 [WetLabsBB2FL](INFO): Powering up 2010-02-05T18:09:53.784Z,1265393393.784 [DAT](INFO): DAT read: Features enabled [Bearing] 2010-02-05T18:09:53.785Z,1265393393.785 [DAT](INFO): DAT read: CONNECT 01200 bits/sec 1 of 4, Rate 1/2 CC 2010-02-05T18:09:53.785Z,1265393393.785 [DAT](INFO): commRate: 1200 2010-02-05T18:09:54.104Z,1265393394.104 [AHRS_M2](DEBUG): Initializing AHRS_M2. 2010-02-05T18:09:54.135Z,1265393394.135 [CTD_Seabird](DEBUG): Initializing CTD_Seabird. 2010-02-05T18:09:55.851Z,1265393395.851 [DAT](INFO): entering command mode 2010-02-05T18:09:56.051Z,1265393396.051 [DAT](INFO): DAT read: 2010-02-05T18:09:56.052Z,1265393396.052 [DAT](INFO): DAT read: user:1> 2010-02-05T18:09:56.052Z,1265393396.052 [DAT](INFO): setting verbose to 3 2010-02-05T18:09:56.304Z,1265393396.304 [DAT](INFO): DAT read: user:1> 2010-02-05T18:09:56.305Z,1265393396.305 [DAT](INFO): DAT read: Verbose | 3 2010-02-05T18:09:56.305Z,1265393396.305 [DAT](INFO): set verbose to 3 2010-02-05T18:09:56.305Z,1265393396.305 [DAT](INFO): setting DatVerbose to 27440 2010-02-05T18:09:56.556Z,1265393396.556 [DAT](INFO): DAT read: user:2> 2010-02-05T18:09:56.557Z,1265393396.557 [DAT](INFO): DAT read: DatVerbose | 27440 2010-02-05T18:09:56.557Z,1265393396.557 [DAT](INFO): set DatVerbose to 27440 2010-02-05T18:09:56.557Z,1265393396.557 [DAT](INFO): setting transmit power to 8 2010-02-05T18:09:56.807Z,1265393396.807 [DAT](INFO): DAT read: user:3> 2010-02-05T18:09:56.808Z,1265393396.808 [DAT](INFO): DAT read: TxPower | 8 (Max) 2010-02-05T18:09:56.809Z,1265393396.809 [DAT](INFO): set transmit power to 8 2010-02-05T18:09:56.809Z,1265393396.809 [DAT](INFO): setting local address to 4 2010-02-05T18:09:57.060Z,1265393397.060 [DAT](INFO): DAT read: user:4> 2010-02-05T18:09:57.061Z,1265393397.061 [DAT](INFO): DAT read: LocalAddr | 4 2010-02-05T18:09:57.061Z,1265393397.061 [DAT](INFO): set local address to 4 2010-02-05T18:09:57.062Z,1265393397.062 [DAT](INFO): Setting time to: 18:9:57 And date to:2/5/2010 2010-02-05T18:09:57.311Z,1265393397.311 [DAT](INFO): DAT read: user:5> 2010-02-05T18:09:57.312Z,1265393397.312 [DAT](INFO): DAT read: Fri Feb 5, 2010 18:09:57 2010-02-05T18:09:57.313Z,1265393397.313 [DAT](INFO): Local DAT time set to Fri Feb 5, 2010 18:09:57 2010-02-05T18:09:57.651Z,1265393397.651 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:09:57.661Z,1265393397.661 [DVL_micro](FAULT): Failed to initialize within timeout. 2010-02-05T18:09:57.661Z,1265393397.661 [DVL_micro] Communications Fault, FailCount= 1 2010-02-05T18:09:57.661Z,1265393397.661 [DVL_micro](ERROR): Communications Fault 2010-02-05T18:09:57.727Z,1265393397.727 [CBIT](ERROR): Communications Fault in component: DVL_micro 2010-02-05T18:09:58.068Z,1265393398.068 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:09:58.147Z,1265393398.147 [DVL_micro](INFO): Powering down 2010-02-05T18:09:58.559Z,1265393398.559 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:09:58.967Z,1265393398.967 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:09:59.026Z,1265393399.026 [CBIT](INFO): Clearing failed state for component DVL_micro 2010-02-05T18:09:59.026Z,1265393399.026 [DVL_micro] No Fault, FailCount= 1 2010-02-05T18:09:59.068Z,1265393399.068 [WetLabsBB2FL] Communications Fault, FailCount= 3 2010-02-05T18:09:59.068Z,1265393399.068 [WetLabsBB2FL](ERROR): Communications Fault 2010-02-05T18:09:59.395Z,1265393399.395 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:09:59.482Z,1265393399.482 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL 2010-02-05T18:09:59.567Z,1265393399.567 [WetLabsBB2FL](INFO): Powering down 2010-02-05T18:09:59.823Z,1265393399.823 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:00.239Z,1265393400.239 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:00.655Z,1265393400.655 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:00.733Z,1265393400.733 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL 2010-02-05T18:10:00.733Z,1265393400.733 [WetLabsBB2FL] No Fault, FailCount= 3 2010-02-05T18:10:00.784Z,1265393400.784 [WetLabsBB2FL](INFO): Powering up 2010-02-05T18:10:01.063Z,1265393401.063 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:01.475Z,1265393401.475 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:01.907Z,1265393401.907 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:02.311Z,1265393402.311 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:02.719Z,1265393402.719 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:03.127Z,1265393403.127 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:03.555Z,1265393403.555 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:03.971Z,1265393403.971 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:04.383Z,1265393404.383 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:04.803Z,1265393404.803 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:05.223Z,1265393405.223 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:05.640Z,1265393405.640 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:06.059Z,1265393406.059 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:06.075Z,1265393406.075 [WetLabsBB2FL] Communications Fault, FailCount= 4 2010-02-05T18:10:06.075Z,1265393406.075 [WetLabsBB2FL](ERROR): Communications Fault 2010-02-05T18:10:06.140Z,1265393406.140 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL 2010-02-05T18:10:06.479Z,1265393406.479 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:06.583Z,1265393406.583 [WetLabsBB2FL](INFO): Powering down 2010-02-05T18:10:06.903Z,1265393406.903 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:07.195Z,1265393407.195 [CTD_Seabird](FAULT): Failed to initialize within timeout. 2010-02-05T18:10:07.195Z,1265393407.195 [CTD_Seabird] Communications Fault, FailCount= 2 2010-02-05T18:10:07.195Z,1265393407.195 [CTD_Seabird](ERROR): Communications Fault 2010-02-05T18:10:07.319Z,1265393407.319 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:07.319Z,1265393407.319 [AHRS_M2](FAULT): Failed to initialize within timeout. 2010-02-05T18:10:07.319Z,1265393407.319 [AHRS_M2] Communications Fault, FailCount= 2 2010-02-05T18:10:07.319Z,1265393407.319 [AHRS_M2](ERROR): Communications Fault 2010-02-05T18:10:07.401Z,1265393407.401 [CBIT](ERROR): Communications Fault in component: CTD_Seabird 2010-02-05T18:10:07.401Z,1265393407.401 [CBIT](INFO): Clearing failed state for component WetLabsBB2FL 2010-02-05T18:10:07.401Z,1265393407.401 [WetLabsBB2FL] No Fault, FailCount= 4 2010-02-05T18:10:07.402Z,1265393407.402 [CBIT](ERROR): Communications Fault in component: AHRS_M2 2010-02-05T18:10:07.419Z,1265393407.419 [AHRS_M2](INFO): Powering down 2010-02-05T18:10:07.600Z,1265393407.600 [CTD_Seabird](INFO): Powering down 2010-02-05T18:10:07.804Z,1265393407.804 [WetLabsBB2FL](INFO): Powering up 2010-02-05T18:10:08.307Z,1265393408.307 [CBIT](INFO): Clearing failed state for component AHRS_M2 2010-02-05T18:10:08.307Z,1265393408.307 [AHRS_M2] No Fault, FailCount= 2 2010-02-05T18:10:08.623Z,1265393408.623 [AHRS_M2](DEBUG): Initializing AHRS_M2. 2010-02-05T18:10:08.641Z,1265393408.641 [NAL9602](INFO): Powering up NAL9602 2010-02-05T18:10:08.695Z,1265393408.695 [CBIT](INFO): Clearing failed state for component CTD_Seabird 2010-02-05T18:10:08.695Z,1265393408.695 [CTD_Seabird] No Fault, FailCount= 2 2010-02-05T18:10:08.943Z,1265393408.943 [CTD_Seabird](DEBUG): Initializing CTD_Seabird. 2010-02-05T18:10:12.175Z,1265393412.175 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:12.587Z,1265393412.587 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:13.007Z,1265393413.007 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:13.091Z,1265393413.091 [WetLabsBB2FL] Communications Fault, FailCount= 5 2010-02-05T18:10:13.091Z,1265393413.091 [WetLabsBB2FL](ERROR): Communications Fault 2010-02-05T18:10:13.427Z,1265393413.427 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:13.479Z,1265393413.479 [CBIT](ERROR): Communications Fault in component: WetLabsBB2FL 2010-02-05T18:10:13.479Z,1265393413.479 [CBIT](FAULT): Communications Fault in component: WetLabsBB2FL 2010-02-05T18:10:13.595Z,1265393413.595 [WetLabsBB2FL](INFO): Powering down 2010-02-05T18:10:13.843Z,1265393413.843 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:14.247Z,1265393414.247 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:14.667Z,1265393414.667 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:15.083Z,1265393415.083 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:15.499Z,1265393415.499 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:15.915Z,1265393415.915 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:16.331Z,1265393416.331 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:16.747Z,1265393416.747 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:16.756Z,1265393416.756 [DVL_micro](FAULT): Failed to initialize within timeout. 2010-02-05T18:10:16.756Z,1265393416.756 [DVL_micro] Communications Fault, FailCount= 2 2010-02-05T18:10:16.756Z,1265393416.756 [DVL_micro](ERROR): Communications Fault 2010-02-05T18:10:16.808Z,1265393416.808 [CBIT](ERROR): Communications Fault in component: DVL_micro 2010-02-05T18:10:17.163Z,1265393417.163 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:17.243Z,1265393417.243 [DVL_micro](INFO): Powering down 2010-02-05T18:10:17.651Z,1265393417.651 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:18.071Z,1265393418.071 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:18.127Z,1265393418.127 [CBIT](INFO): Clearing failed state for component DVL_micro 2010-02-05T18:10:18.127Z,1265393418.127 [DVL_micro] No Fault, FailCount= 2 2010-02-05T18:10:18.483Z,1265393418.483 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:18.895Z,1265393418.895 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:19.303Z,1265393419.303 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:19.731Z,1265393419.731 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:19.741Z,1265393419.741 [NAL9602](INFO): NAL9602 initialized 2010-02-05T18:10:20.147Z,1265393420.147 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:20.567Z,1265393420.567 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:20.983Z,1265393420.983 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:21.427Z,1265393421.427 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:21.855Z,1265393421.855 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:21.855Z,1265393421.855 [AHRS_M2](FAULT): Failed to initialize within timeout. 2010-02-05T18:10:21.855Z,1265393421.855 [AHRS_M2] Communications Fault, FailCount= 3 2010-02-05T18:10:21.855Z,1265393421.855 [AHRS_M2](ERROR): Communications Fault 2010-02-05T18:10:21.907Z,1265393421.907 [CBIT](ERROR): Communications Fault in component: AHRS_M2 2010-02-05T18:10:21.952Z,1265393421.952 [AHRS_M2](INFO): Powering down 2010-02-05T18:10:21.995Z,1265393421.995 [CTD_Seabird](FAULT): Failed to initialize within timeout. 2010-02-05T18:10:21.995Z,1265393421.995 [CTD_Seabird] Communications Fault, FailCount= 3 2010-02-05T18:10:21.995Z,1265393421.995 [CTD_Seabird](ERROR): Communications Fault 2010-02-05T18:10:22.093Z,1265393422.093 [CBIT](ERROR): Communications Fault in component: CTD_Seabird 2010-02-05T18:10:22.094Z,1265393422.094 [CBIT](FAULT): Communications Fault in component: CTD_Seabird 2010-02-05T18:10:22.401Z,1265393422.401 [CTD_Seabird](INFO): Powering down 2010-02-05T18:10:22.864Z,1265393422.864 [CBIT](INFO): Clearing failed state for component AHRS_M2 2010-02-05T18:10:22.864Z,1265393422.864 [AHRS_M2] No Fault, FailCount= 3 2010-02-05T18:10:23.133Z,1265393423.133 [AHRS_M2](DEBUG): Initializing AHRS_M2. 2010-02-05T18:10:26.440Z,1265393426.440 [CommandExec](IMPORTANT): got command restart system 2010-02-05T18:10:26.691Z,1265393426.691 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:27.103Z,1265393427.103 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:27.511Z,1265393427.511 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:27.927Z,1265393427.927 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:28.507Z,1265393428.507 [CommandExec ThreadHandler](INFO): Uninitializing protected caller thread. 2010-02-05T18:10:28.507Z,1265393428.507 [CommandExec](INFO): Uninitializing the command executive. 2010-02-05T18:10:28.507Z,1265393428.507 [CommandExec](INFO): Uninitializing the command scheduler. 2010-02-05T18:10:28.508Z,1265393428.508 [CommandExec ThreadHandler](INFO): Thread cancelled. 2010-02-05T18:10:28.511Z,1265393428.511 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:28.662Z,1265393428.662 [Supervisor](DEBUG): Uninitializing supervisor and starting cleanup. Bye! 2010-02-05T18:10:28.662Z,1265393428.662 [ComponentRegistry](INFO): Shutting down NavChartDb ThreadHandler 2010-02-05T18:10:28.663Z,1265393428.663 [NavChartDb ThreadHandler](INFO): Thread cancelled. 2010-02-05T18:10:28.663Z,1265393428.663 [NavChartDb](INFO): Join timeout helper Thread ID is 963 2010-02-05T18:10:28.955Z,1265393428.955 [AHRS_M2](ERROR): setBoresightMatrix UART error: serial timeout 2010-02-05T18:10:28.987Z,1265393428.987 [NavChartDb ThreadHandler](INFO): Uninitializing protected caller thread. 2010-02-05T18:10:28.987Z,1265393428.987 [NavChartDb ThreadHandler](INFO): Thread cancelled. 2010-02-05T18:10:29.007Z,1265393429.007 [ComponentRegistry](INFO): Shutting down DAT ThreadHandler 2010-02-05T18:10:29.007Z,1265393429.007 [DAT ThreadHandler](INFO): Thread cancelled. 2010-02-05T18:10: