search

awawa-dev / HyperHDR

Highly optimized open source ambient lighting implementation based on modern digital video and audio stream analysis for Windows, macOS and Linux (x86 and Raspberry Pi / ARM).
http://www.hyperhdr.eu/
MIT License
1.05k stars 110 forks source link

No video feed at system boot #857

Closed amigthea closed 4 months ago

amigthea commented 4 months ago

Bug report, debug log and your config file (FULL LOGS ARE MANDATORY)

2024-05-14T05:54:58.076Z [CORE] TTY is not attached to the log output
2024-05-14T05:54:58.129Z [MAIN] Database path: '/home/andrea/.hyperhdr/db/hyperhdr.db', readonlyMode = disabled
2024-05-14T05:54:58.132Z [MAIN] Starting HyperHdr - 20.0.0.0, (HEAD detached at v20.0.0.0) (awawa-dev-9e960c9/52f12b4-1711236142), built: Mar 23 2024:23:58:38
2024-05-14T05:54:58.132Z [MAIN] Set user data path to '/home/andrea/.hyperhdr'
2024-05-14T05:54:58.135Z [INSTANCE_CFG] Loading instance configuration
2024-05-14T05:54:58.193Z [DB] Database opened: /home/andrea/.hyperhdr/db/hyperhdr.db
2024-05-14T05:54:58.229Z [INSTANCE_CFG] Settings database initialized
2024-05-14T05:54:58.251Z [SOUND_GRABBER] Sound device is disabled
2024-05-14T05:54:58.362Z [JSONSERVER] (JsonServer.cpp:26) Created new instance
2024-05-14T05:54:58.366Z [JSONSERVER] Started on port 19444
2024-05-14T05:54:58.367Z [SSDP] (SSDPHandler.cpp:31) SSDPHandler is initialized
2024-05-14T05:54:58.309Z [V4L2:USB3.0 UHD: US] (GrabberWrapper.cpp:55) Starting the grabber wrapper
2024-05-14T05:54:58.309Z [V4L2:USB3.0 UHD: US] Found capture device: /dev/video15
2024-05-14T05:54:58.309Z [V4L2:USB3.0 UHD: US] Found capture device: /dev/video21
2024-05-14T05:54:58.310Z [V4L2:USB3.0 UHD: US] Found capture device: /dev/video14
2024-05-14T05:54:58.310Z [V4L2:USB3.0 UHD: US] Found capture device: /dev/video22
2024-05-14T05:54:58.311Z [X11_SYSTEM:AUTO] Loaded X11 proxy library for screen capturing
2024-05-14T05:54:58.315Z [HYPERHDR0] Starting the instance
2024-05-14T05:54:58.315Z [DAEMON] The system doesn't support the X11 system grabber
2024-05-14T05:54:58.315Z [INSTANCE_CFG0] Loading instance configuration
2024-05-14T05:54:58.316Z [DAEMON] The system doesn't support the framebuffer system grabber
2024-05-14T05:54:58.316Z [DB] Database opened: /home/andrea/.hyperhdr/db/hyperhdr.db
2024-05-14T05:54:58.316Z [X11_SYSTEM:auto] (SystemWrapper.cpp:71) Closing grabber: X11_SYSTEM:auto
2024-05-14T05:54:58.316Z [FRAMEBUF_SYSTEM:auto] (SystemWrapper.cpp:71) Closing grabber: FRAMEBUF_SYSTEM:auto
2024-05-14T05:54:58.372Z [INSTANCE_CFG0] Settings database initialized
2024-05-14T05:54:58.372Z [COMPONENTCTRL0] (ComponentController.cpp:31) ComponentController is initialized. Components are ENABLED
2024-05-14T05:54:58.375Z [MUXER0] (Muxer.cpp:55) Muxer initialized
2024-05-14T05:54:58.375Z [BLACKBORDER] Set mode to: default
2024-05-14T05:54:58.375Z [COMPONENTCTRL0] Blackborder detector: enabled
2024-05-14T05:54:58.376Z [IMAGETOLED_MNG0] (ImageToLedManager.cpp:192) Set LED mapping type to advanced
2024-05-14T05:54:58.376Z [IMAGETOLED_MNG0] (ImageToLedManager.cpp:176) setSparseProcessing to 0
2024-05-14T05:54:58.376Z [IMAGETOLED_MNG0] (ImageToLedManager.cpp:103) ImageToLedManager initialized
2024-05-14T05:54:58.379Z [COLORSPACE_CALIBRATION0] classicMode: no, gammas:[1.50, 1.50, 1.50], saturation: 1.00, luminance: 1.00, backLight: [enabled, threshold: 0, colored: no]
2024-05-14T05:54:58.379Z [LED_CALIBRATION0] (LedCalibration.cpp:101) Calibration config '0' for LED segment: [0, 223]
2024-05-14T05:54:58.381Z [HYPERHDR0] Led strip RGB order is: rgb
2024-05-14T05:54:58.382Z [SMOOTHING0] High resolution clock is NOT STEADY!
2024-05-14T05:54:58.382Z [SMOOTHING0] Clearing queued colors before: enabling
2024-05-14T05:54:58.382Z [SMOOTHING0] Smoothing queue is cleared
2024-05-14T05:54:58.382Z [COMPONENTCTRL0] Smoothing: enabled
2024-05-14T05:54:58.382Z [SMOOTHING0] Creating config (0) => type: Alternative, dirMode: false, pause: false, settlingTime: 150ms, interval: 10ms (100Hz), antiFlickTres: 32, antiFlickStep: 2, antiFlickTime: 250
2024-05-14T05:54:58.382Z [SMOOTHING0] Clearing queued colors before: enabling. Smoothing configuration changed: restarting timer.
2024-05-14T05:54:58.382Z [SMOOTHING0] Smoothing queue is cleared
2024-05-14T05:54:58.382Z [SMOOTHING0] Selecting config (0) => type: Alternative, directMode: false, pause: false, settlingTime: 150ms, interval: 10ms (100Hz), antiFlickTres: 32, antiFlickStep: 2, antiFlickTime: 250
2024-05-14T05:54:58.382Z [SMOOTHING0] Selecting config (0) => type: Alternative, directMode: false, pause: false, settlingTime: 150ms, interval: 10ms (100Hz), antiFlickTres: 32, antiFlickStep: 2, antiFlickTime: 250
2024-05-14T05:54:58.383Z [LEDDEVICE0_AWA_SPI] Start LedDevice 'awa_spi'.
2024-05-14T05:54:58.383Z [LEDDEVICE0_AWA_SPI] (LedDevice.cpp:337) deviceConfig: [{"colorOrder":"rgb","currentLedCount":224,"invert":false,"output":"/dev/spidev0.0","rate":25000000,"refreshTime":10,"smoothingRefreshTime":10,"spitype":"esp32","type":"awa_spi","white_channel_calibration":false}]
2024-05-14T05:54:58.383Z [LEDDEVICE0_AWA_SPI] Ignoring user LED refresh rate. Forcing smoothing refresh rate = 100.00 Hz
2024-05-14T05:54:58.383Z [LEDDEVICE0_AWA_SPI] (LedDevice.cpp:423) Refresh rate = 100.00 Hz
2024-05-14T05:54:58.383Z [LEDDEVICE0_AWA_SPI] (LedDevice.cpp:373) Device is not ready to start a timer
2024-05-14T05:54:58.383Z [LEDDEVICE0_AWA_SPI] (LedDevice.cpp:433) Refresh interval updated to 10ms
2024-05-14T05:54:58.383Z [LEDDEVICE0_AWA_SPI] (ProviderSpi.cpp:52) Speed: 25000000, Type: esp32
2024-05-14T05:54:58.383Z [LEDDEVICE0_AWA_SPI] (ProviderSpi.cpp:53) Inverted: no, Mode: 0
2024-05-14T05:54:58.383Z [LEDDEVICE0_AWA_SPI] The refresh timer is enabled ('Refresh time' > 0) and may limit the performance of the LED driver. Ignore this error if you set it on purpose for some reason (but you almost never need it).
2024-05-14T05:54:58.383Z [LEDDEVICE0_AWA_SPI] (LedDeviceAWA_spi.cpp:52) SPI driver with data integration check AWA protocol
2024-05-14T05:54:58.383Z [LEDDEVICE0_AWA_SPI] (LedDeviceAWA_spi.cpp:60) SPI header for 224 leds: Awa 0x00 0xdf 0x8a
2024-05-14T05:54:58.383Z [LEDDEVICE0_AWA_SPI] (LedDevice.cpp:247) Enable the device
2024-05-14T05:54:58.384Z [LEDDEVICE0_AWA_SPI] (LedDevice.cpp:64) Switch on
2024-05-14T05:54:58.384Z [LEDDEVICE0_AWA_SPI] (LedDevice.cpp:140) Power On
2024-05-14T05:54:58.384Z [LEDDEVICE0_AWA_SPI] (LedDevice.cpp:367) Starting timer with interval = 10ms
2024-05-14T05:54:58.384Z [HYPER_MANAGER] HyperHDR instance 'Blacky' has been started
2024-05-14T05:54:58.384Z [HYPERHDR0] The instance is running
2024-05-14T05:54:58.384Z [MUXER0] Register new input 'System/VIDEOGRABBER' with priority 240 as inactive
2024-05-14T05:54:58.384Z [COMPONENTCTRL0] Video capture device: enabled
2024-05-14T05:54:58.384Z [COMPONENTCTRL0] LED device: enabled
2024-05-14T05:54:58.384Z [SMOOTHING0] Using alternative smoothing input (0)
2024-05-14T05:54:58.404Z [SMOOTHING0] Using alternative smoothing procedure (0)
2024-05-14T05:54:58.421Z [V4L2:USB3.0 UHD: US] Found capture device: /dev/video0
2024-05-14T05:54:58.434Z [V4L2:USB3.0 UHD: US] (V4L2Grabber.cpp:406) Device has 'brightness' control => min: 0, max: 100, default: 50
2024-05-14T05:54:58.449Z [V4L2:USB3.0 UHD: US] (V4L2Grabber.cpp:412) Device has 'contrast' control => min: 0, max: 100, default: 50
2024-05-14T05:54:58.462Z [V4L2:USB3.0 UHD: US] (V4L2Grabber.cpp:418) Device has 'saturation' control => min: 0, max: 100, default: 50
2024-05-14T05:54:58.475Z [V4L2:USB3.0 UHD: US] (V4L2Grabber.cpp:424) Device has 'hue' control => min: 0, max: 100, default: 50
2024-05-14T05:54:58.476Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1920 x 1080 @ 60 fps yuyv input 0
2024-05-14T05:54:58.476Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1920 x 1080 @ 50 fps yuyv input 0
2024-05-14T05:54:58.476Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1920 x 1080 @ 30 fps yuyv input 0
2024-05-14T05:54:58.476Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1920 x 1080 @ 20 fps yuyv input 0
2024-05-14T05:54:58.476Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1920 x 1080 @ 10 fps yuyv input 0
2024-05-14T05:54:58.476Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1600 x 1200 @ 60 fps yuyv input 0
2024-05-14T05:54:58.476Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1600 x 1200 @ 50 fps yuyv input 0
2024-05-14T05:54:58.476Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1600 x 1200 @ 30 fps yuyv input 0
2024-05-14T05:54:58.476Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1600 x 1200 @ 20 fps yuyv input 0
2024-05-14T05:54:58.476Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1600 x 1200 @ 10 fps yuyv input 0
2024-05-14T05:54:58.476Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1360 x 768 @ 60 fps yuyv input 0
2024-05-14T05:54:58.476Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1360 x 768 @ 50 fps yuyv input 0
2024-05-14T05:54:58.476Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1360 x 768 @ 30 fps yuyv input 0
2024-05-14T05:54:58.476Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1360 x 768 @ 20 fps yuyv input 0
2024-05-14T05:54:58.476Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1360 x 768 @ 10 fps yuyv input 0
2024-05-14T05:54:58.476Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1280 x 1024 @ 60 fps yuyv input 0
2024-05-14T05:54:58.476Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1280 x 1024 @ 50 fps yuyv input 0
2024-05-14T05:54:58.476Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1280 x 1024 @ 30 fps yuyv input 0
2024-05-14T05:54:58.476Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1280 x 1024 @ 20 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1280 x 1024 @ 10 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1280 x 960 @ 60 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1280 x 960 @ 50 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1280 x 960 @ 30 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1280 x 960 @ 20 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1280 x 960 @ 10 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1280 x 720 @ 60 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1280 x 720 @ 50 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1280 x 720 @ 30 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1280 x 720 @ 20 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1280 x 720 @ 10 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1024 x 768 @ 60 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1024 x 768 @ 50 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1024 x 768 @ 30 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1024 x 768 @ 20 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1024 x 768 @ 10 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 800 x 600 @ 60 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 800 x 600 @ 50 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 800 x 600 @ 30 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 800 x 600 @ 20 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 800 x 600 @ 10 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 720 x 576 @ 60 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 720 x 576 @ 50 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 720 x 576 @ 30 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 720 x 576 @ 20 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 720 x 576 @ 10 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 720 x 480 @ 60 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 720 x 480 @ 50 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 720 x 480 @ 30 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 720 x 480 @ 20 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 720 x 480 @ 10 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 640 x 480 @ 60 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 640 x 480 @ 50 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 640 x 480 @ 30 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 640 x 480 @ 20 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 640 x 480 @ 10 fps yuyv input 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] Restarting video grabber is now blocked due to reloading of the configuration
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] Cropping image: width=0 height=0; crop: left=0 right=0 top=0 bottom=0 
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] (GrabberWrapper.cpp:126) CEC keycode. Start: 0, stop: 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] (Grabber.cpp:159) Set new width: 1280, height: 720 for capture
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] (Grabber.cpp:335) setWidthHeight preparing to restarting video grabber 0
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] Delayed restart of the grabber due to change of the capturing resolution
2024-05-14T05:54:58.478Z [V4L2:USB3.0 UHD: US] Delayed restart of the grabber due to change of the framerate
2024-05-14T05:54:58.479Z [V4L2:USB3.0 UHD: US] (Grabber.cpp:273) setBrightnessContrastSaturationHue nothing changed
2024-05-14T05:54:58.479Z [V4L2:USB3.0 UHD: US] setHdrToneMappingMode to: enable, but the LUT file is currently unloaded
2024-05-14T05:54:58.479Z [V4L2:USB3.0 UHD: US] (Grabber.cpp:182) setFpsSoftwareDecimation to: 1
2024-05-14T05:54:58.479Z [SIGNAL_OLD] (DetectionManual.cpp:84) Signal detection area set to: 0.250000,0.250000 x 0.750000,0.750000
2024-05-14T05:54:58.479Z [SIGNAL_OLD] (DetectionManual.cpp:74) Signal threshold set to: {0, 0, 0} and frames: 50
2024-05-14T05:54:58.479Z [SIGNAL_AUTO] (DetectionAutomatic.cpp:375) Automatic signal detection -> errorTolerance: 9, modelTolerance: 90, sleepTime: 1000, wakeTime: 0
2024-05-14T05:54:58.479Z [V4L2:USB3.0 UHD: US] (Grabber.cpp:380) setDeviceVideoStandard preparing to restart video grabber. Old: '' new: 'USB3.0 UHD: USB3.0 UHD (video0)'
2024-05-14T05:54:58.479Z [V4L2:USB3.0 UHD: US] Delayed restart of the grabber due to change of selected device
2024-05-14T05:54:58.479Z [V4L2:USB3.0 UHD: US] (Grabber.cpp:200) Force encoding to: yuyv (old: NO_CHANGE)
2024-05-14T05:54:58.479Z [V4L2:USB3.0 UHD: US] Delayed restart of the grabber due to change of the video encoding format
2024-05-14T05:54:58.479Z [V4L2:USB3.0 UHD: US] setQFrameDecimation is now: disabled
2024-05-14T05:54:58.479Z [V4L2:USB3.0 UHD: US] Multithreading for V4L2 is enabled. Available thread's count 3
2024-05-14T05:54:58.479Z [V4L2:USB3.0 UHD: US] Found capture device: /dev/video15
2024-05-14T05:54:58.479Z [WEBSERVER] Initialize Webserver
2024-05-14T05:54:58.479Z [COMPONENTCTRL0] HDR (global): enabled
2024-05-14T05:54:58.480Z [V4L2:USB3.0 UHD: US] Found capture device: /dev/video21
2024-05-14T05:54:58.481Z [V4L2:USB3.0 UHD: US] Found capture device: /dev/video14
2024-05-14T05:54:58.481Z [V4L2:USB3.0 UHD: US] Found capture device: /dev/video22
2024-05-14T05:54:58.481Z [FLATBUFSERVER] Started on port 19400
2024-05-14T05:54:58.481Z [V4L2:USB3.0 UHD: US] Found capture device: /dev/video0
2024-05-14T05:54:58.481Z [V4L2:USB3.0 UHD: US] (V4L2Grabber.cpp:406) Device has 'brightness' control => min: 0, max: 100, default: 50
2024-05-14T05:54:58.481Z [V4L2:USB3.0 UHD: US] (V4L2Grabber.cpp:412) Device has 'contrast' control => min: 0, max: 100, default: 50
2024-05-14T05:54:58.481Z [V4L2:USB3.0 UHD: US] (V4L2Grabber.cpp:418) Device has 'saturation' control => min: 0, max: 100, default: 50
2024-05-14T05:54:58.481Z [V4L2:USB3.0 UHD: US] (V4L2Grabber.cpp:424) Device has 'hue' control => min: 0, max: 100, default: 50
2024-05-14T05:54:58.481Z [FLATBUFSERVER] Started local domain socket server: 'hyperhdr-domain'
2024-05-14T05:54:58.482Z [V4L2:USB3.0 UHD: US] (V4L2Grabber.cpp:213) Searching for USB3.0 UHD: USB3.0 UHD (video0) 1280 x 720 @ 60 fps, input: -1 (yuyv)
2024-05-14T05:54:58.482Z [V4L2:USB3.0 UHD: US] *************************************************************************************************
2024-05-14T05:54:58.482Z [V4L2:USB3.0 UHD: US] Starting V4L2 grabber. Selected: USB3.0 UHD: USB3.0 UHD (video0) [/dev/video0] 1280 x 720 @ 60 fps yuyv input -1
2024-05-14T05:54:58.482Z [V4L2:USB3.0 UHD: US] *************************************************************************************************
2024-05-14T05:54:58.482Z [V4L2:USB3.0 UHD: US] (V4L2Grabber.cpp:826) Hardware cropping is not supported: ignoring
2024-05-14T05:54:58.482Z [V4L2:USB3.0 UHD: US] Set device input to: Camera 1
2024-05-14T05:54:58.482Z [NETFORWARDER] Forwarder has changed state to disabled
2024-05-14T05:54:58.499Z [V4L2:USB3.0 UHD: US] Set resolution to: 1280 x 720
2024-05-14T05:54:58.516Z [V4L2:USB3.0 UHD: US] Set framerate to 60 FPS
2024-05-14T05:54:58.519Z [V4L2:USB3.0 UHD: US] Brightness set to: 50 (default)
2024-05-14T05:54:58.523Z [V4L2:USB3.0 UHD: US] Contrast set to: 50 (default)
2024-05-14T05:54:58.526Z [V4L2:USB3.0 UHD: US] Saturation set to: 50 (default)
2024-05-14T05:54:58.529Z [V4L2:USB3.0 UHD: US] Hue set to: 50 (default)
2024-05-14T05:54:58.529Z [V4L2:USB3.0 UHD: US] (V4L2Grabber.cpp:105) LUT folder location: '/usr/share/hyperhdr/lut'
2024-05-14T05:54:58.529Z [V4L2:USB3.0 UHD: US] (Grabber.cpp:458) LUT file found: /home/andrea/.hyperhdr/lut_lin_tables.3d
2024-05-14T05:54:58.529Z [V4L2:USB3.0 UHD: US] (Grabber.cpp:468) Index 1 for HDR YUV
2024-05-14T05:54:58.637Z [MUXER0] Set visible priority to 255
2024-05-14T05:54:58.637Z [HYPERHDR0] New priority[255], previous [255]
2024-05-14T05:54:58.637Z [HYPERHDR0] No source left -> switch LED-Device off
2024-05-14T05:54:58.637Z [SMOOTHING0] Clearing queued colors before: disabling
2024-05-14T05:54:58.637Z [SMOOTHING0] Smoothing queue is cleared
2024-05-14T05:54:58.637Z [COLORSPACE_CALIBRATION0] (ColorSpaceCalibration.cpp:225) setBackLightEnabled: 0
2024-05-14T05:54:58.637Z [LEDDEVICE0_AWA_SPI] (LedDevice.cpp:297) Disable the device
2024-05-14T05:54:58.637Z [LEDDEVICE0_AWA_SPI] (LedDevice.cpp:381) Stopping refresh timer
2024-05-14T05:54:58.637Z [LEDDEVICE0_AWA_SPI] (LedDevice.cpp:90) Switch off
2024-05-14T05:54:58.637Z [LEDDEVICE0_AWA_SPI] (LedDevice.cpp:126) Power Off
2024-05-14T05:54:58.637Z [LEDDEVICE0_AWA_SPI] (LedDevice.cpp:544) Set LED strip to black/power off
2024-05-14T05:54:58.638Z [LEDDEVICE0_AWA_SPI] (ProviderSpi.cpp:135) Closing SPI interface
2024-05-14T05:54:58.638Z [COMPONENTCTRL0] LED device: disabled
2024-05-14T05:54:59.414Z [WEBSERVER] Apply Webserver settings
2024-05-14T05:54:59.414Z [WEBSERVER] Set document root to: :/www
2024-05-14T05:54:59.414Z [WEBSERVER] Started: 'HyperHDR WebServer (HTTP)' on port: 8090
2024-05-14T05:54:59.414Z [SSDP] (SSDPHandler.cpp:93) The local address is empty
2024-05-14T05:54:59.414Z [WEBSERVER] Initialize Webserver
2024-05-14T05:54:59.414Z [WEBSERVER] Apply Webserver settings
2024-05-14T05:54:59.414Z [WEBSERVER] Set document root to: :/www
2024-05-14T05:54:59.805Z [WEBSERVER] Setup SSL certificate
2024-05-14T05:54:59.807Z [WEBSERVER] Setup private SSL key
2024-05-14T05:54:59.808Z [WEBSERVER] Started: 'HyperHDR WebServer (HTTPS)' on port: 8092
2024-05-14T05:54:59.808Z [SSDP] (SSDPHandler.cpp:42) SSDPHandler is initializing
2024-05-14T05:54:59.808Z [SSDP] Could not obtain the local address. Retry later (1/10)
2024-05-14T05:54:59.808Z [SSDP] (SSDPServer.cpp:95) Initialize the SSDP server
2024-05-14T05:54:59.808Z [SSDP] (SSDPHandler.cpp:93) The local address is empty
2024-05-14T05:54:59.890Z [V4L2:USB3.0 UHD: US] Found and loaded LUT: '/home/andrea/.hyperhdr/lut_lin_tables.3d'
2024-05-14T05:54:59.890Z [V4L2:USB3.0 UHD: US] Video pixel format is set to: YUYV
2024-05-14T05:54:59.898Z [V4L2:USB3.0 UHD: US] Started
2024-05-14T05:54:59.935Z [V4L2:USB3.0 UHD: US] (V4L2Grabber.cpp:1164) Worker's thread count  = 3
2024-05-14T05:54:59.941Z [MUXER0] Priority 240 is now active
2024-05-14T05:54:59.941Z [MUXER0] Set visible priority to 240
2024-05-14T05:54:59.941Z [HYPERHDR0] New priority[240], previous [255]
2024-05-14T05:54:59.941Z [HYPERHDR0] New source available -> switch LED-Device on
2024-05-14T05:54:59.941Z [SMOOTHING0] Clearing queued colors before: enabling
2024-05-14T05:54:59.941Z [SMOOTHING0] Smoothing queue is cleared
2024-05-14T05:54:59.941Z [COLORSPACE_CALIBRATION0] (ColorSpaceCalibration.cpp:225) setBackLightEnabled: 1
2024-05-14T05:54:59.941Z [LEDDEVICE0_AWA_SPI] (LedDevice.cpp:247) Enable the device
2024-05-14T05:54:59.942Z [LEDDEVICE0_AWA_SPI] (LedDevice.cpp:64) Switch on
2024-05-14T05:54:59.942Z [LEDDEVICE0_AWA_SPI] (LedDevice.cpp:140) Power On
2024-05-14T05:54:59.942Z [LEDDEVICE0_AWA_SPI] (LedDevice.cpp:367) Starting timer with interval = 10ms
2024-05-14T05:54:59.944Z [IMAGETOLED_MNG0] Total index number is: 240640 (memory: 240640). User sparse processing is: disabled, image size: 1280 x 720, area number: 224
2024-05-14T05:54:59.946Z [COMPONENTCTRL0] LED device: enabled
2024-05-14T05:54:59.947Z [SMOOTHING0] Using alternative smoothing input (0)
2024-05-14T05:54:59.962Z [SMOOTHING0] Using alternative smoothing procedure (0)
2024-05-14T05:55:00.951Z [NET_DISCOVERY] Found ESP board at ttyACM0:-1 (USB Single Serial)
2024-05-14T05:55:00.916Z [SERVICE_mDNS] Starting the network discovery thread
2024-05-14T05:55:03.944Z [MUXER0] Priority 240 is now inactive
2024-05-14T05:55:03.945Z [MUXER0] Set visible priority to 255
2024-05-14T05:55:03.945Z [HYPERHDR0] New priority[255], previous [240]
2024-05-14T05:55:03.945Z [HYPERHDR0] No source left -> switch LED-Device off
2024-05-14T05:55:03.945Z [SMOOTHING0] Clearing queued colors before: disabling
2024-05-14T05:55:03.945Z [SMOOTHING0] Smoothing queue is cleared
2024-05-14T05:55:03.945Z [LEDDEVICE0_AWA_SPI] (LedDevice.cpp:297) Disable the device
2024-05-14T05:55:03.945Z [COLORSPACE_CALIBRATION0] (ColorSpaceCalibration.cpp:225) setBackLightEnabled: 0
2024-05-14T05:55:03.945Z [LEDDEVICE0_AWA_SPI] (LedDevice.cpp:381) Stopping refresh timer
2024-05-14T05:55:03.945Z [LEDDEVICE0_AWA_SPI] (LedDevice.cpp:90) Switch off
2024-05-14T05:55:03.945Z [LEDDEVICE0_AWA_SPI] (LedDevice.cpp:126) Power Off
2024-05-14T05:55:03.945Z [LEDDEVICE0_AWA_SPI] (LedDevice.cpp:544) Set LED strip to black/power off
2024-05-14T05:55:03.946Z [LEDDEVICE0_AWA_SPI] (ProviderSpi.cpp:135) Closing SPI interface
2024-05-14T05:55:03.946Z [COMPONENTCTRL0] LED device: disabled
2024-05-14T05:55:29.771Z [SSDP] (SSDPHandler.cpp:42) SSDPHandler is initializing
2024-05-14T05:55:29.772Z [SSDP] (SSDPHandler.cpp:183) The local address is: 192.168.0.100
2024-05-14T05:55:29.772Z [SSDP] (SSDPServer.cpp:95) Initialize the SSDP server
2024-05-14T05:55:29.772Z [WEBSERVER] (StaticFileServing.cpp:68) SSDP description is set up
2024-05-14T05:55:29.773Z [SSDP] Starting the SSDP server
2024-05-14T05:56:04.259Z [WEBSOCKET] (WebSocketClient.cpp:39) New connection from ::ffff:192.168.0.10
2024-05-14T05:56:14.853Z [WEBSOCKET] (HyperAPI.cpp:1109) message: [{"command":"leddevice","ledDeviceType":"awa_spi","subcommand":"discover","tan":937}]
2024-05-14T05:56:14.854Z [LEDDEVICE_AWA_SPI] (ProviderSpi.cpp:319) SPI devices discovered: [{"devices":[{"name":"/dev/spidev0.0","value":"/dev/spidev0.0"},{"name":"/dev/spidev0.1","value":"/dev/spidev0.1"}],"ledDeviceType":"awa_spi"}]
2024-05-14T05:56:14.854Z [WEBSOCKET] (HyperAPI.cpp:1133) response: [{"devices":[{"name":"/dev/spidev0.0","value":"/dev/spidev0.0"},{"name":"/dev/spidev0.1","value":"/dev/spidev0.1"}],"ledDeviceType":"awa_spi"}]
2024-05-14T05:57:41.600Z [WEBSOCKET] (HyperAPI.cpp:957) log streaming activated for client ::ffff:192.168.0.10

Steps to reproduce

just boot the system

What is expected?

to have a working video feed

What is actually happening?

there's no video feed until a restart of hyperhdr service

System

HyperHDR Server: 
- Build:           (HEAD detached at v20.0.0.0) (awawa-dev-9e960c9/52f12b4-1711236142)
- Build time:      Mar 23 2024 23:55:32
- Git Remote:      https://github.com/awawa-dev/HyperHDR
- Version:         20.0.0.0
- UI Lang:         auto (BrowserLang: en-US)
- Avail Capt:      Linux (V4L2)
- Database:        read/write

HyperHDR Server OS: 
- Distribution:   Debian GNU/Linux 12 (bookworm)
- Architecture:   arm64
- CPU Type:       Raspberry Pi 4 Model B Rev 1.5
- CPU Hardware:   c03115
- Kernel:         linux (6.6.20+rpt-rpi-v8 (WS: 64))
- Qt Version:     5.15.8
- Browser:        Mozilla/5.0 (X11; Linux x86_64; rv:125.0) Gecko/20100101 Firefox/125.0
awawa-dev commented 4 months ago

Hi I don't see an issue in this log related to HyperHDR. The grabber is initialized fine without any errors but it won't provide any video stream and that's why video priority is removed after some time. A bit strange symptom is a pause while listing available grabbers which may indicate a hardware problem with the grabber or USB connection (hub, broken cable, insufficient power supply etc). Or dying SD card causing core Kernel modules to take long to initialize. But in such cases the video grabber cannot be found in HyperHDR while starting after the boot or always refuses to initialized properly then in HyperHDR and throws an error. You can try to add a delay to HyperHDR service as a workaround (search repo for similar problem) and see if it helps. And you must verify dmesg logs. Anyway it's not a HyperHDR issue.

amigthea commented 4 months ago

that's an awesome insight, thank you for the quick feedback!

I was keeping the service delay workaround as my last resolve, but I might go for it seeing that could be something not so trivial, that probably worths a lot of troubleshooting time.

amigthea commented 4 months ago

ps: after I manually restart the service it start working as I wrote bit it logs "Frame too small" errors too

2024-05-14T08:26:42.962Z [V4L2:USB3.0 UHD: US] Video pixel format is set to: YUYV
2024-05-14T08:26:42.970Z [V4L2:USB3.0 UHD: US] Started
2024-05-14T08:26:42.971Z [V4L2:USB3.0 UHD: US] Frame too small: 0 != 1843200
2024-05-14T08:26:42.972Z [V4L2:USB3.0 UHD: US] Frame too small: 0 != 1843200
2024-05-14T08:26:42.972Z [V4L2:USB3.0 UHD: US] Frame too small: 0 != 1843200
2024-05-14T08:26:42.972Z [V4L2:USB3.0 UHD: US] Frame too small: 0 != 1843200
2024-05-14T08:26:42.988Z [V4L2:USB3.0 UHD: US] (V4L2Grabber.cpp:1164) Worker's thread count  = 3
2024-05-14T08:26:42.995Z [MUXER0] Priority 240 is now active
2024-05-14T08:26:42.995Z [MUXER0] Set visible priority to 240

could they be related to the problem?

awawa-dev commented 4 months ago

No, this is usually fine when the capturing starts up. I often observe this when a callback returns then an empty frame (different grabbers). But after that it should no longer appear and the grabber's video source with priority 240 should not be removed (which proves that the correct frames are coming in)