# flake8: noqa # pylint: disable=broad-exception-raised, raise-missing-from, too-many-arguments, redefined-outer-name # pylance: disable=reportMissingImports, reportMissingModuleSource, reportGeneralTypeIssues # type: ignore import warnings warnings.filterwarnings("ignore", category=Warning) import re from datetime import datetime, timedelta, timezone import subprocess import os import time import random import sys import pkg_resources import requests import json from collections import deque required_packages = { 'grist-api': 'latest', 'colorama': 'latest', 'requests': '2.31.0', 'urllib3': '2.0.7', 'charset-normalizer': '3.3.2' } installed_packages = {pkg.key: pkg.version for pkg in pkg_resources.working_set} for package, version in required_packages.items(): if package not in installed_packages or (version != 'latest' and installed_packages[package] != version): if version == 'latest': subprocess.check_call([sys.executable, '-m', 'pip', 'install', package, '--break-system-packages']) else: subprocess.check_call([sys.executable, '-m', 'pip', 'install', f"{package}=={version}", '--break-system-packages']) from grist_api import GristDocAPI import colorama import logging import socket STATE_FILE_PATH = '/root/node/sync_state.json' def self_update(logger): logger.info("Checking for updates..") script_path = os.path.abspath(__file__) update_url = "https://gitea.vvzvlad.xyz/vvzvlad/ritual/raw/branch/main-22aug/checker.py" try: response = requests.get(update_url, timeout=10) if response.status_code == 200: current_content = "" with open(script_path, 'r', encoding='utf-8') as f: current_content = f.read() if current_content != response.text: with open(script_path, 'w', encoding='utf-8') as f: f.write(response.text) logger.info("Script updated successfully, restarting") os.execv(sys.executable, ['python3'] + sys.argv) else: logger.info("Script is up to date") else: logger.error(f"Failed to download update, status code: {response.status_code}") except Exception as e: logger.error(f"Update error: {str(e)}") class GRIST: def __init__(self, server, doc_id, api_key, logger): self.server = server self.doc_id = doc_id self.api_key = api_key self.logger = logger self.grist = GristDocAPI(doc_id, server=server, api_key=api_key) def table_name_convert(self, table_name): return table_name.replace(" ", "_") def to_timestamp(self, dtime: datetime) -> int: if dtime.tzinfo is None: dtime = dtime.replace(tzinfo=timezone(timedelta(hours=3))) return int(dtime.timestamp()) def insert_row(self, data, table): data = {key.replace(" ", "_"): value for key, value in data.items()} row_id = self.grist.add_records(self.table_name_convert(table), [data]) return row_id def update_column(self, row_id, column_name, value, table): if isinstance(value, datetime): value = self.to_timestamp(value) column_name = column_name.replace(" ", "_") self.grist.update_records(self.table_name_convert(table), [{ "id": row_id, column_name: value }]) def delete_row(self, row_id, table): self.grist.delete_records(self.table_name_convert(table), [row_id]) def update(self, row_id, updates, table): for column_name, value in updates.items(): if isinstance(value, datetime): updates[column_name] = self.to_timestamp(value) updates = {column_name.replace(" ", "_"): value for column_name, value in updates.items()} self.grist.update_records(self.table_name_convert(table), [{"id": row_id, **updates}]) def fetch_table(self, table): return self.grist.fetch_table(self.table_name_convert(table)) def find_record(self, id=None, state=None, name=None, table=None): if table is None: raise ValueError("Table is not specified") table_data = self.grist.fetch_table(self.table_name_convert(table)) if id is not None: record = [row for row in table_data if row.id == id] return record if state is not None and name is not None: record = [row for row in table_data if row.State == state and row.name == name] return record if state is not None: record = [row for row in table_data if row.State == state] return record if name is not None: record = [row for row in table_data if row.Name == name] return record def find_settings(self, key, table): table = self.fetch_table(self.table_name_convert(table)) for record in table: if record.Setting == key: if record.Value is None or record.Value == "": raise ValueError(f"Setting {key} blank") return record.Value raise ValueError(f"Setting {key} not found") def read_state(logger): """Reads the last known state (status and sync count) from the state file.""" default_state = {"last_status": "Idle", "sync_count": 0} if not os.path.exists(STATE_FILE_PATH): logger.info(f"State file {STATE_FILE_PATH} not found, starting with default state.") return default_state try: with open(STATE_FILE_PATH, 'r', encoding='utf-8') as f: state = json.load(f) # Validate state structure if "last_status" not in state or "sync_count" not in state: logger.warning(f"Invalid state file format in {STATE_FILE_PATH}, using default state.") return default_state # Ensure sync_count is an integer state["sync_count"] = int(state["sync_count"]) return state except (json.JSONDecodeError, ValueError, IOError) as e: logger.error(f"Error reading or parsing state file {STATE_FILE_PATH}: {e}. Using default state.") return default_state def write_state(state, logger): """Writes the current state to the state file.""" try: with open(STATE_FILE_PATH, 'w', encoding='utf-8') as f: json.dump(state, f, indent=4) except IOError as e: logger.error(f"Error writing state file {STATE_FILE_PATH}: {e}") def clean_ansi(text): ansi_escape = re.compile(r'\x1B(?:[@-Z\\-_]|\[[0-?]*[ -/]*[@-~])') return ansi_escape.sub('', text) def format_number(number_str): try: number = int(number_str) if number >= 1000: return f"{number//1000}k" return str(number) except (ValueError, TypeError): return "NaN" # Or some other indicator of invalid input def check_logs(logger): state = read_state(logger) original_sync_count = state["sync_count"] previous_status = state["last_status"] try: logs = subprocess.run(['docker', 'logs', '--since', '10m', 'infernet-node'], capture_output=True, text=True, check=True) log_content = clean_ansi(logs.stdout) last_checking_info = None last_ignored_id = None last_head_sub_id = None # Regex patterns checking_pattern = re.compile(r'Checking subscriptions.*last_sub_id=(\d+).*head_sub_id=(\d+).*num_subs_to_sync=(\d+)') ignored_pattern = re.compile(r'Ignored subscription creation.*id=(\d+)') head_sub_pattern = re.compile(r'head sub id is:\s*(\d+)') # Use deque to efficiently get the last few relevant lines if needed, # but processing all lines and keeping the last match is simpler here. for line in log_content.splitlines(): match = checking_pattern.search(line) if match: last_checking_info = { "last_sub_id": match.group(1), "head_sub_id": match.group(2), "num_subs_to_sync": int(match.group(3)) } continue # Prioritize checking_info match = ignored_pattern.search(line) if match: last_ignored_id = match.group(1) continue match = head_sub_pattern.search(line) if match: last_head_sub_id = match.group(1) # No continue here, allows checking_info from same timeframe to override current_status_type = "Idle" status_message = "Idle" if last_checking_info: formatted_id = format_number(last_checking_info["last_sub_id"]) if last_checking_info["num_subs_to_sync"] > 0: current_status_type = "Sync" status_message = f"Sync: {formatted_id} ({state['sync_count']})" logger.info(f"Node is syncing. Last sub ID: {last_checking_info['last_sub_id']}, Num subs to sync: {last_checking_info['num_subs_to_sync']}") else: current_status_type = "OK" # Increment count only on transition from Sync to OK based on the *last* status type if previous_status == "Sync": state["sync_count"] += 1 logger.info(f"Sync completed. Sync count incremented to {state['sync_count']}.") status_message = f"OK: {formatted_id} ({state['sync_count']})" logger.info(f"Node is OK. Last sub ID: {last_checking_info['last_sub_id']}") elif last_ignored_id: # Fallback to "Ignored" logs if "Checking" is missing formatted_id = format_number(last_ignored_id) current_status_type = "Sync" # Assume sync if we only see ignored creations recently status_message = f"Sync: {formatted_id} ({state['sync_count']})" logger.info(f"Node possibly syncing (based on ignored logs). Last ignored ID: {last_ignored_id}") elif last_head_sub_id: # Fallback to "head sub id" if others are missing formatted_id = format_number(last_head_sub_id) current_status_type = "OK" # Assume OK if this is the latest relevant info status_message = f"OK: {formatted_id} ({state['sync_count']})" logger.info(f"Node status based on head sub id. Head sub ID: {last_head_sub_id}") else: logger.info("No relevant subscription log entries found in the last 10 minutes. Status: Idle.") status_message = "Idle" current_status_type = "Idle" # Update state and write back if changed state["last_status"] = current_status_type if state["sync_count"] != original_sync_count or state["last_status"] != previous_status: write_state(state, logger) return {"status": status_message} except subprocess.CalledProcessError as e: logger.error(f"Error running docker logs command: {e.stderr or e.stdout or e}") # Don't update state file on command error, keep previous state return {"status": f"Error: Docker logs failed ({e.returncode})"} except Exception as e: logger.error(f"Unexpected error processing logs: {e}", exc_info=True) # Don't update state file on unexpected error return {"status": f"Error: Log processing failed"} if __name__ == "__main__": colorama.init(autoreset=True) logger = logging.getLogger("Checker") logger.setLevel(logging.INFO) formatter = logging.Formatter("%(asctime)s - %(name)s - %(levelname)s - %(message)s") ch = logging.StreamHandler() ch.setFormatter(formatter) logger.addHandler(ch) logger.info("Checker started") self_update(logger) #random_sleep = random.randint(1, 60) #logger.info(f"Sleeping for {random_sleep} seconds") #time.sleep(random_sleep) grist_data = {} with open('/root/node/grist_1.json', 'r', encoding='utf-8') as f: grist_data = json.loads(f.read()) GRIST_ROW_NAME = socket.gethostname() NODES_TABLE = "Nodes" grist = GRIST(grist_data.get('grist_server'), grist_data.get('grist_doc_id'), grist_data.get('grist_api_key'), logger) current_vm = grist.find_record(name=GRIST_ROW_NAME, table=NODES_TABLE)[0] def grist_callback(msg): grist.update(current_vm.id, msg, NODES_TABLE) for attempt in range(3): try: result = check_logs(logger) grist_callback({ "Health": result["status"] }) logger.info(f"Status: {result['status']} ()") if result["status"] == "Idle": grist_callback({ "Health": "Rebooting" }) os.system("reboot") except Exception as e: logger.error(f"Error on attempt {attempt+1}/3: {e}") if attempt == 2: grist_callback({ "Health": f"Error: {e}" }) if attempt < 2: time.sleep(5)