2025-10-16T22:36:55.746722574Z [migrations] started
2025-10-16T22:36:55.761447629Z [migrations] no migrations found
2025-10-16T22:36:56.801415462Z usermod: no changes
2025-10-16T22:36:56.964649579Z ───────────────────────────────────────
2025-10-16T22:36:56.964687004Z 
2025-10-16T22:36:56.964695842Z       ██╗     ███████╗██╗ ██████╗
2025-10-16T22:36:56.964704399Z       ██║     ██╔════╝██║██╔═══██╗
2025-10-16T22:36:56.964713287Z       ██║     ███████╗██║██║   ██║
2025-10-16T22:36:56.964721974Z       ██║     ╚════██║██║██║   ██║
2025-10-16T22:36:56.964729860Z       ███████╗███████║██║╚██████╔╝
2025-10-16T22:36:56.964736554Z       ╚══════╝╚══════╝╚═╝ ╚═════╝
2025-10-16T22:36:56.964743137Z 
2025-10-16T22:36:56.964749339Z    Brought to you by linuxserver.io
2025-10-16T22:36:56.964755712Z ───────────────────────────────────────
2025-10-16T22:36:56.973640459Z 
2025-10-16T22:36:56.973845772Z To support LSIO projects visit:
2025-10-16T22:36:56.973857245Z https://www.linuxserver.io/donate/
2025-10-16T22:36:56.973861955Z 
2025-10-16T22:36:56.974012468Z ───────────────────────────────────────
2025-10-16T22:36:56.974019442Z GID/UID
2025-10-16T22:36:56.974372302Z ───────────────────────────────────────
2025-10-16T22:36:57.105510573Z 
2025-10-16T22:36:57.105557507Z User UID:    911
2025-10-16T22:36:57.105562828Z User GID:    911
2025-10-16T22:36:57.105567167Z ───────────────────────────────────────
2025-10-16T22:36:57.149592589Z Linuxserver.io version: 144.0-1-ls100
2025-10-16T22:36:57.154071176Z Build-date: 2025-10-16T22:23:05+00:00
2025-10-16T22:36:57.154108661Z ───────────────────────────────────────
2025-10-16T22:36:57.154113632Z     
2025-10-16T22:37:00.231879180Z ..+..+.+......+.....+...+.......+...+.....+......+++++++++++++++++++++++++++++++++++++++*.......+......+.....+.+++++++++++++++++++++++++++++++++++++++*.......+............+.+...++++++
2025-10-16T22:37:00.599912292Z ..+.+..+.+.........+............+...........+..........+..+.+.................+....+......+.....+.......+++++++++++++++++++++++++++++++++++++++*..+..+................+.....+.........+...................+.....+++++++++++++++++++++++++++++++++++++++*.....+...+.+....................+.+..............+.+.........+...........+.+.........+...+.....+.+..+....+...+...+...+..+....+...+...+...+............+.....+.......+..+.........+.......+...+..+...+.......+............+.....+...+...+.+...+...............+.....+.......+.....+...+......+.+...+.................+....+..+..........+.....+....+.....+...+......................+...+...+...+.....+.........+...+.......+..+......+...+.+...+..+......+.......+......+..+.......+..+...+......+.+...........+.......+......+.....+.+....................+.+........+......+...............+.+.....+.........+.....................+...+.........+.++++++
2025-10-16T22:37:00.652868705Z -----
2025-10-16T22:37:09.708003659Z [ls.io-init] Creating initial backup of menu.xml
2025-10-16T22:37:16.395969698Z [ls.io-init] Creating initial backup of system rc.xml
2025-10-16T22:37:27.272024961Z [custom-init] No custom files found, skipping...
2025-10-16T22:37:29.683912439Z _XSERVTransmkdir: ERROR: euid != 0,directory /tmp/.X11-unix will not be created.
2025-10-16T22:37:29.703934879Z screen 0 shmid 0
2025-10-16T22:37:30.640127013Z xsettingsd: Loaded 1 setting from /config/.xsettingsd
2025-10-16T22:37:30.828412274Z [ls.io-init] done.
2025-10-16T22:37:32.931982743Z xsettingsd: Created window 0x400001 on screen 0 with timestamp 2560805020
2025-10-16T22:37:32.941002422Z xsettingsd: Selection _XSETTINGS_S0 is owned by 0x0
2025-10-16T22:37:32.941030187Z xsettingsd: Took ownership of selection _XSETTINGS_S0
2025-10-16T22:37:33.476636182Z 17
2025-10-16T22:37:34.050854122Z 18
2025-10-16T22:37:37.347993884Z INFO:data_websocket:pcmflux library found. Audio capture is available.
2025-10-16T22:37:38.304914411Z INFO:data_websocket:pixelflux library found. Striped encoding modes available.
2025-10-16T22:37:39.543993656Z INFO:root:Expected C js_config_t size (from ctypes): 1354 bytes
2025-10-16T22:37:40.931986438Z INFO:main:Upload directory ensured: /config/Desktop
2025-10-16T22:37:40.956015945Z INFO:main:Starting Selkies (WebSocket Mode) with settings: {'audio_enabled': (True, False), 'microphone_enabled': (True, False), 'gamepad_enabled': (True, False), 'clipboard_enabled': (True, False), 'command_enabled': (True, False), 'file_transfers': ['upload', 'download'], 'encoder': 'x264enc', 'framerate': (8, 120), 'h264_crf': (5, 50), 'jpeg_quality': (1, 100), 'h264_fullcolor': (False, False), 'h264_streaming_mode': (False, False), 'use_cpu': (False, False), 'use_paint_over_quality': (True, False), 'paint_over_jpeg_quality': (1, 100), 'h264_paintover_crf': (5, 50), 'h264_paintover_burst_frames': (1, 30), 'second_screen': (True, False), 'audio_bitrate': '320000', 'is_manual_resolution_mode': (False, False), 'manual_width': 0, 'manual_height': 0, 'scaling_dpi': '96', 'enable_binary_clipboard': (False, False), 'use_browser_cursors': (False, False), 'use_css_scaling': (False, False), 'ui_title': 'Selkies', 'ui_show_logo': (True, False), 'ui_show_core_buttons': (True, False), 'ui_show_sidebar': (True, False), 'ui_sidebar_show_video_settings': (True, False), 'ui_sidebar_show_screen_settings': (True, False), 'ui_sidebar_show_audio_settings': (True, False), 'ui_sidebar_show_stats': (True, False), 'ui_sidebar_show_clipboard': (True, False), 'ui_sidebar_show_files': (True, False), 'ui_sidebar_show_apps': (True, False), 'ui_sidebar_show_sharing': (True, False), 'ui_sidebar_show_gamepads': (True, False), 'ui_sidebar_show_fullscreen': (True, False), 'ui_sidebar_show_gaming_mode': (True, False), 'ui_sidebar_show_trackpad': (True, False), 'ui_sidebar_show_keyboard_button': (True, False), 'ui_sidebar_show_soft_buttons': (True, False), 'port': 8082, 'dri_node': '', 'audio_device_name': 'output.monitor', 'watermark_path': '', 'watermark_location': -1, 'debug': (False, False), 'enable_sharing': (True, False), 'enable_collab': (True, False), 'enable_shared': (True, False), 'enable_player2': (True, False), 'enable_player3': (True, False), 'enable_player4': (True, False)}
2025-10-16T22:37:40.960234377Z INFO:main:Initial Encoder: x264enc, Framerate: 60
2025-10-16T22:37:40.960283176Z INFO:main:SelkiesStreamingApp initialized: encoder=x264enc, display=1024x768
2025-10-16T22:37:40.960289037Z INFO:main:All main components initialized. Running server...
2025-10-16T22:37:41.032190090Z INFO:webrtc_input:System DPI detected as ~96. Cursor size cap set to 32x32px.
2025-10-16T22:37:41.088719888Z INFO:webrtc_input:Resetting keyboard modifiers.
2025-10-16T22:37:41.115300941Z INFO:webrtc_input:Clipboard monitor running (binary mode: False)
2025-10-16T22:37:41.204267040Z INFO:webrtc_input:Found XFIXES version 4.0
2025-10-16T22:37:41.204312061Z INFO:webrtc_input:starting cursor monitor
2025-10-16T22:37:41.204318544Z INFO:webrtc_input:watching for cursor changes
2025-10-16T22:37:41.308257707Z WARNING:data_websocket:Cannot broadcast cursor data: no clients connected or server not ready.
2025-10-16T22:37:41.385831701Z INFO:data_websocket:Data WebSocket Server listening on port 8082
2025-10-16T22:37:43.123986308Z INFO:webrtc_input:Initializing 4 persistent gamepad instances...
2025-10-16T22:37:43.135988120Z INFO:root:Packed js_config payload for 'Microsoft X-Box 360 pad' (js0): len=1360 bytes. Name='Microsoft X-Box 360 pad', Vendor=0x045e, Product=0x028e, Version=0x0100, Reported Buttons=11 (Array capacity: 512), Reported Axes=8 (Array capacity: 64)
2025-10-16T22:37:43.136032460Z INFO:selkies_gamepad:Gamepad configured. JS socket: /tmp/selkies_js0.sock, EVDEV socket: /tmp/selkies_event1000.sock. Using fixed config: Microsoft X-Box 360 pad
2025-10-16T22:37:43.136038552Z INFO:webrtc_input:Initialized and started persistent gamepad instance for index 0 (Name: 'Microsoft X-Box 360 pad', JS: /tmp/selkies_js0.sock, EVDEV: /tmp/selkies_event1000.sock).
2025-10-16T22:37:43.136044183Z INFO:root:Packed js_config payload for 'Microsoft X-Box 360 pad' (js1): len=1360 bytes. Name='Microsoft X-Box 360 pad', Vendor=0x045e, Product=0x028e, Version=0x0100, Reported Buttons=11 (Array capacity: 512), Reported Axes=8 (Array capacity: 64)
2025-10-16T22:37:43.136050275Z INFO:selkies_gamepad:Gamepad configured. JS socket: /tmp/selkies_js1.sock, EVDEV socket: /tmp/selkies_event1001.sock. Using fixed config: Microsoft X-Box 360 pad
2025-10-16T22:37:43.136055696Z INFO:webrtc_input:Initialized and started persistent gamepad instance for index 1 (Name: 'Microsoft X-Box 360 pad', JS: /tmp/selkies_js1.sock, EVDEV: /tmp/selkies_event1001.sock).
2025-10-16T22:37:43.136061438Z INFO:root:Packed js_config payload for 'Microsoft X-Box 360 pad' (js2): len=1360 bytes. Name='Microsoft X-Box 360 pad', Vendor=0x045e, Product=0x028e, Version=0x0100, Reported Buttons=11 (Array capacity: 512), Reported Axes=8 (Array capacity: 64)
2025-10-16T22:37:43.136067320Z INFO:selkies_gamepad:Gamepad configured. JS socket: /tmp/selkies_js2.sock, EVDEV socket: /tmp/selkies_event1002.sock. Using fixed config: Microsoft X-Box 360 pad
2025-10-16T22:37:43.136095937Z INFO:webrtc_input:Initialized and started persistent gamepad instance for index 2 (Name: 'Microsoft X-Box 360 pad', JS: /tmp/selkies_js2.sock, EVDEV: /tmp/selkies_event1002.sock).
2025-10-16T22:37:43.143970090Z INFO:root:Packed js_config payload for 'Microsoft X-Box 360 pad' (js3): len=1360 bytes. Name='Microsoft X-Box 360 pad', Vendor=0x045e, Product=0x028e, Version=0x0100, Reported Buttons=11 (Array capacity: 512), Reported Axes=8 (Array capacity: 64)
2025-10-16T22:37:43.144015551Z INFO:selkies_gamepad:Gamepad configured. JS socket: /tmp/selkies_js3.sock, EVDEV socket: /tmp/selkies_event1003.sock. Using fixed config: Microsoft X-Box 360 pad
2025-10-16T22:37:43.144021423Z INFO:webrtc_input:Initialized and started persistent gamepad instance for index 3 (Name: 'Microsoft X-Box 360 pad', JS: /tmp/selkies_js3.sock, EVDEV: /tmp/selkies_event1003.sock).
2025-10-16T22:37:43.151971208Z INFO:selkies_gamepad:Gamepad /tmp/selkies_js0.sock: Event processor started.
2025-10-16T22:37:43.152013423Z INFO:selkies_gamepad:JS interposer server listening on /tmp/selkies_js0.sock
2025-10-16T22:37:43.152019064Z INFO:selkies_gamepad:Gamepad /tmp/selkies_js1.sock: Event processor started.
2025-10-16T22:37:43.152024826Z INFO:selkies_gamepad:JS interposer server listening on /tmp/selkies_js1.sock
2025-10-16T22:37:43.152030067Z INFO:selkies_gamepad:Gamepad /tmp/selkies_js2.sock: Event processor started.
2025-10-16T22:37:43.152035287Z INFO:selkies_gamepad:JS interposer server listening on /tmp/selkies_js2.sock
2025-10-16T22:37:43.152040487Z INFO:selkies_gamepad:Gamepad /tmp/selkies_js3.sock: Event processor started.
2025-10-16T22:37:43.160713308Z INFO:selkies_gamepad:JS interposer server listening on /tmp/selkies_js3.sock
2025-10-16T22:37:43.160740623Z INFO:selkies_gamepad:EVDEV interposer server listening on /tmp/selkies_event1000.sock
2025-10-16T22:37:43.167970187Z INFO:selkies_gamepad:EVDEV interposer server listening on /tmp/selkies_event1001.sock
2025-10-16T22:37:43.168010849Z INFO:selkies_gamepad:EVDEV interposer server listening on /tmp/selkies_event1002.sock
2025-10-16T22:37:43.168017041Z INFO:selkies_gamepad:EVDEV interposer server listening on /tmp/selkies_event1003.sock
2025-10-16T22:37:59.528778400Z WARNING:webrtc_input:Error reading clipboard with xclip: 
2025-10-16T22:38:05.340104033Z WARNING:webrtc_input:Error reading clipboard with xclip: 
2025-10-16T22:38:07.287989912Z dbus-daemon[972]: [system] Activating service name='org.freedesktop.login1' requested by ':1.15' (uid=911 pid=1578 comm="/qemu/qemu-aarch64 /usr/bin/librewolf") (using servicehelper)
2025-10-16T22:38:07.300543766Z dbus-daemon[972]: [system] Activating service name='org.freedesktop.timedate1' requested by ':1.15' (uid=911 pid=1578 comm="/qemu/qemu-aarch64 /usr/bin/librewolf") (using servicehelper)
2025-10-16T22:38:07.323968665Z dbus-daemon[972]: [system] Activated service 'org.freedesktop.login1' failed: Failed to execute program org.freedesktop.login1: Permission denied
2025-10-16T22:38:14.597291308Z WARNING:webrtc_input:Error reading clipboard with xclip: 
2025-10-16T22:38:16.136167890Z WARNING:webrtc_input:Error reading clipboard with xclip: 
2025-10-16T22:38:24.089569396Z WARNING:webrtc_input:Error reading clipboard with xclip: 
2025-10-16T22:38:25.614285942Z WARNING:webrtc_input:Error reading clipboard with xclip: 
2025-10-16T22:38:38.255356410Z WARNING:data_websocket:Cannot broadcast cursor data: no clients connected or server not ready.
2025-10-16T22:39:01.257443866Z WARNING:webrtc_input:Error reading clipboard with xclip: 
2025-10-16T22:39:08.859200136Z WARNING:webrtc_input:Error reading clipboard with xclip: 
2025-10-16T22:39:20.255722663Z WARNING:webrtc_input:Error reading clipboard with xclip: 
2025-10-16T22:39:28.475074284Z WARNING:webrtc_input:Error reading clipboard with xclip: 
2025-10-16T22:39:35.074178168Z INFO:data_websocket:Data WebSocket connected from ('127.0.0.1', 50186)
2025-10-16T22:39:35.075422823Z INFO:data_websocket:Sending last known cursor to new client ('127.0.0.1', 50186)
2025-10-16T22:39:35.100002659Z INFO:data_websocket:Attempting to establish PulseAudio connection...
2025-10-16T22:39:35.177129373Z INFO:data_websocket:PulseAudio connection established.
2025-10-16T22:39:35.186851065Z INFO:data_websocket:Registering new client for display: primary
2025-10-16T22:39:35.187154866Z INFO:data_websocket:Applying and sanitizing client settings for 'primary' (initial=True)
2025-10-16T22:39:35.187957402Z INFO:data_websocket:DPI changed from None to 96. Applying system-level change.
2025-10-16T22:39:35.190927462Z INFO:gst_app_resize:Openbox detected. Applying xrdb for DPI 96.
2025-10-16T22:39:35.192247499Z INFO:gst_app_resize:Wrote 'Xft.dpi:   96' to /config/.Xresources.
2025-10-16T22:39:36.606935292Z INFO:gst_app_resize:Successfully loaded /config/.Xresources using xrdb.
2025-10-16T22:39:36.608559322Z INFO:gst_app_resize:Wrote font and DPI settings to /config/.xsettingsd.
2025-10-16T22:39:36.743584289Z INFO:gst_app_resize:Found xsettingsd process with PID: 995.
2025-10-16T22:39:36.804525358Z xsettingsd: Reloading configuration
2025-10-16T22:39:36.807573174Z xsettingsd: Loaded 5 settings from /config/.xsettingsd
2025-10-16T22:39:36.811156007Z INFO:gst_app_resize:Sent SIGHUP to xsettingsd process 995 to reload config.
2025-10-16T22:39:37.463726557Z INFO:data_websocket:Initial setup or dimensional change detected for 'primary'. Performing full display reconfiguration.
2025-10-16T22:39:37.463948474Z INFO:data_websocket:Starting display reconfiguration...
2025-10-16T22:39:37.465783178Z INFO:data_websocket:Calculating new extended desktop layout from ALL clients...
2025-10-16T22:39:37.466296842Z INFO:data_websocket:Layout calculated: Total Size=1920x992. Layouts: {'primary': {'x': 0, 'y': 0, 'w': 1920, 'h': 992}}
2025-10-16T22:39:37.734430278Z INFO:data_websocket:Mode 1920x992 not found. Creating it.
2025-10-16T22:39:38.126362130Z INFO:data_websocket:Defining logical monitors for the window manager...
2025-10-16T22:39:38.324546543Z INFO:data_websocket:Starting separate capture instances for each ACTIVE display region...
2025-10-16T22:39:38.324999866Z INFO:data_websocket:Client 'primary' is active. Starting its capture.
2025-10-16T22:39:38.325527348Z INFO:data_websocket:Preparing to start capture for display='primary': Res=1920x992, Offset=0x0
2025-10-16T22:39:38.354489315Z INFO:data_websocket:Video chunk sender started for display 'primary'.
2025-10-16T22:39:38.361202901Z INFO:data_websocket:SUCCESS: Capture started for 'primary'.
2025-10-16T22:39:38.361886216Z INFO:data_websocket:New frame backpressure task started for display 'primary'.
2025-10-16T22:39:38.362663251Z INFO:data_websocket:Broadcasting primary stream resolution to all clients: {"type": "stream_resolution", "width": 1920, "height": 992}
2025-10-16T22:39:38.364246668Z INFO:data_websocket:Broadcasting display config update: DISPLAY_CONFIG_UPDATE,{"type": "display_config_update", "displays": ["primary"]}
2025-10-16T22:39:38.365225128Z INFO:data_websocket:Display reconfiguration finished successfully.
2025-10-16T22:39:38.365846289Z INFO:data_websocket:Reconfiguration process complete (state unlocked).
2025-10-16T22:39:38.366630227Z INFO:data_websocket:Initial client settings message processed by ws_handler.
2025-10-16T22:39:38.367313793Z INFO:data_websocket:Initial setup: Primary client connected, audio not active, attempting start.
2025-10-16T22:39:38.367792878Z INFO:data_websocket:Starting pcmflux audio pipeline...
2025-10-16T22:39:38.369420555Z INFO:data_websocket:pcmflux settings: device='output.monitor', bitrate=320000, channels=2
2025-10-16T22:39:38.373402672Z INFO:data_websocket:Frame-based backpressure logic task started for display 'primary'.
2025-10-16T22:39:38.373937438Z INFO:data_websocket:Client settings received, proceeding with backpressure loop for 'primary'.
2025-10-16T22:39:38.383034904Z INFO:data_websocket:pcmflux audio capture started successfully.
2025-10-16T22:39:38.394761562Z [pcmflux] Attempting to connect to PulseAudio device: output.monitor...
2025-10-16T22:39:38.400946414Z X Shared Memory Extension available.
2025-10-16T22:39:38.404112638Z INFO:data_websocket:pcmflux audio chunk broadcasting task started.
2025-10-16T22:39:38.405040727Z XShm setup complete for 1920x992.
2025-10-16T22:39:38.406940111Z CPU cores available: 64
2025-10-16T22:39:38.428984421Z Stream settings active -> Res: 1920x992 | FPS: 60.0 | Stripes: 1 | Mode: H264 (CPU) FullFrame | CRF: 25 | PaintOver CRF: 18 (Burst: 5f) | Colorspace: I420 (Limited Range) | Damage Thresh: 10f | Damage Dur: 20f
2025-10-16T22:39:38.495916531Z INFO:data_websocket:Received START_AUDIO command from client for server-to-client audio.
2025-10-16T22:39:38.496340565Z INFO:data_websocket:START_AUDIO: pcmflux audio pipeline already active.
2025-10-16T22:39:38.498286012Z INFO:data_websocket:Client is taking over existing display 'primary'. Updating state for new connection.
2025-10-16T22:39:38.498692650Z INFO:data_websocket:Applying and sanitizing client settings for 'primary' (initial=False)
2025-10-16T22:39:38.500400458Z INFO:data_websocket:Received redundant resize request for primary (1920x992). No action taken.
2025-10-16T22:39:38.542429733Z [pcmflux] SUCCESS: Connected to PulseAudio.
2025-10-16T22:39:38.545662061Z [pcmflux] SUCCESS: Opus encoder created.
2025-10-16T22:39:38.549740562Z [pcmflux] Capture loop started. Device: output.monitor, Rate: 48000, Channels: 2, Bitrate: 320 kbps, VBR: On, Silence Gate: Off, Debug Logging: Off, PCM Chunk: 3840 bytes
2025-10-16T22:39:40.512484683Z [pcmflux] First non-silent audio chunk detected! Encoding...
2025-10-16T22:39:45.107901033Z INFO:data_websocket:Cleaning up Data WS handler for ('127.0.0.1', 50186) (Display ID: primary)...
2025-10-16T22:39:45.108266349Z INFO:data_websocket:Client for 'primary' disconnected. Removing and triggering full display reconfiguration.
2025-10-16T22:39:45.108496913Z INFO:data_websocket:Starting display reconfiguration...
2025-10-16T22:39:45.108709681Z INFO:data_websocket:Stopping all existing capture and backpressure tasks...
2025-10-16T22:39:45.120711794Z Capture loop stopped. X resources released.
2025-10-16T22:39:45.124223084Z INFO:data_websocket:All capture instances, senders, and backpressure tasks stopped.
2025-10-16T22:39:45.124445902Z WARNING:data_websocket:No display clients connected. Video pipelines remain stopped.
2025-10-16T22:39:45.144310865Z INFO:data_websocket:Video chunk sender for 'primary' cancelled.
2025-10-16T22:39:45.144579316Z INFO:data_websocket:Video chunk sender for 'primary' finished.