Current Status of Nano Modularize - nvv4l2decoder

[jamitupya]

Hey, looking like some awesome progress :-) Just did a build based off of "roflcoopter/jetson-nano-viseron:dev" since that looked the most recent in the nano side and receiving this error. is this the correct repo or have you not merged everything yet?

i think this entry relates i think to the setup of the camera, only occurs once per camera' stream, and goes away if i set the camera to VBR vs CBR streams
[2022-11-20 10:22:44] [ERROR ] [viseron.components.gstreamer.stream.camera_2] - [h264 @ 0x55c7e014e0] cabac decode of qscale diff failed at 40 59

[2022-11-20 10:22:36] [INFO    ] [viseron.core] - Shutdown complete
[cont-finish.d] executing container finish scripts...
[cont-finish.d] done.
[s6-finish] waiting for services.
[viseron-finish] Viseron exit code 0
s6-svscanctl: fatal: unable to control /var/run/s6/services: supervisor not listening
[s6-finish] sending all processes the TERM signal.
[s6-finish] sending all processes the KILL signal and exiting.
[s6-init] making user provided files available at /var/run/s6/etc...exited 0.
[s6-init] ensuring user provided files have correct perms...exited 0.
[fix-attrs.d] applying ownership & permissions fixes...
[fix-attrs.d] done.
[cont-init.d] executing container initialization scripts...
[cont-init.d] 10-adduser: executing... 
usermod: no changes
************************ UID/GID *************************
User uid:    0
User gid:    0
************************** Done **************************
[cont-init.d] 10-adduser: exited 0.
[cont-init.d] 20-gid-video-device: executing... 
[cont-init.d] 20-gid-video-device: exited 0.
[cont-init.d] 30-edgetpu-permission: executing... 
************** Setting EdgeTPU permissions ***************
Coral Vendor IDs:
"1a6e"
"18d1"
No EdgeTPU USB device was found
************************** Done **************************
[cont-init.d] 30-edgetpu-permission: exited 0.
[cont-init.d] 40-set-env-vars: executing... 
****** Checking for hardware acceleration platforms ******
OpenCL cannot be used
VA-API cannot be used
CUDA cannot be used
*********************** Done *****************************
[cont-init.d] 40-set-env-vars: exited 0.
[cont-init.d] 50-check-if-rpi: executing... 
********** Checking if we are running on an RPi **********
Not running on any supported RPi
*********************** Done *****************************
[cont-init.d] 50-check-if-rpi: exited 0.
[cont-init.d] 55-check-if-jetson: executing... 
****** Checking if we are running on a Jetson Board ******
Running on a Jetson Nano
*********************** Done *****************************
[cont-init.d] 55-check-if-jetson: exited 0.
[cont-init.d] 60-ffmpeg-path: executing... 
****************** Getting FFmpeg path *******************
FFmpeg path: /usr/bin/ffmpeg
*********************** Done *****************************
[cont-init.d] 60-ffmpeg-path: exited 0.
[cont-init.d] 70-gstreamer-path: executing... 
***************** Getting GStreamer path *****************
GStreamer path: /usr/bin/gst-launch-1.0
*********************** Done *****************************
[cont-init.d] 70-gstreamer-path: exited 0.
[cont-init.d] done.
[services.d] starting services
[services.d] done.
[2022-11-20 10:22:42] [INFO    ] [viseron.core] - -------------------------------------------
[2022-11-20 10:22:42] [INFO    ] [viseron.core] - Initializing Viseron
[2022-11-20 10:22:42] [INFO    ] [viseron.components] - Setting up component logger
[2022-11-20 10:22:42] [INFO    ] [viseron.components] - Setup of component logger took 0.0 seconds
[2022-11-20 10:22:42] [INFO    ] [viseron.components] - Setting up component data_stream
[2022-11-20 10:22:42] [DEBUG   ] [viseron.watchdog] - Registering <RestartableThread(data_stream, initial daemon)> in the watchdog
[2022-11-20 10:22:42] [INFO    ] [viseron.components] - Setup of component data_stream took 0.0 seconds
[2022-11-20 10:22:42] [INFO    ] [viseron.components] - Setting up component webserver
[2022-11-20 10:22:42] [DEBUG   ] [asyncio] - Using selector: EpollSelector
[2022-11-20 10:22:42] [INFO    ] [viseron.components] - Setup of component webserver took 0.0 seconds
[2022-11-20 10:22:42] [INFO    ] [viseron.components] - Setting up component mqtt
[2022-11-20 10:22:42] [INFO    ] [viseron.components] - Setting up component mog2
[2022-11-20 10:22:42] [INFO    ] [viseron.components] - Setting up component gstreamer
[2022-11-20 10:22:42] [INFO    ] [viseron.components] - Setting up component nvr
[2022-11-20 10:22:42] [INFO    ] [viseron.components] - Setup of component nvr took 0.0 seconds
[2022-11-20 10:22:42] [INFO    ] [viseron.components] - Setup of component gstreamer took 0.0 seconds
[2022-11-20 10:22:42] [INFO    ] [viseron.components] - Setup of component mog2 took 0.0 seconds
[2022-11-20 10:22:42] [DEBUG   ] [viseron.watchdog] - Registering <RestartableThread(viseron.components.mqtt.publisher, initial daemon)> in the watchdog
[2022-11-20 10:22:42] [DEBUG   ] [viseron.components.mqtt] - MQTT connected with returncode 0
[2022-11-20 10:22:42] [INFO    ] [viseron.components] - Setup of component mqtt took 0.0 seconds
[2022-11-20 10:22:43] [INFO    ] [viseron.components] - Setting up domain camera for component gstreamer with identifier camera_2
[2022-11-20 10:22:43] [INFO    ] [viseron.components] - Setting up domain motion_detector for component mog2 with identifier camera_2
[2022-11-20 10:22:43] [INFO    ] [viseron.components] - Setting up domain nvr for component nvr with identifier camera_2
[2022-11-20 10:22:43] [DEBUG   ] [viseron.components] - Domain nvr for component nvr with identifier camera_2 will wait for dependencies ['domain: camera, identifier: camera_2']
[2022-11-20 10:22:43] [DEBUG   ] [viseron.components] - Domain nvr for component nvr with identifier camera_2 will wait for optional dependencies ['domain: motion_detector, identifier: camera_2']
[2022-11-20 10:22:43] [DEBUG   ] [viseron.components] - Domain motion_detector for component mog2 with identifier camera_2 will wait for dependencies ['domain: camera, identifier: camera_2']
[2022-11-20 10:22:43] [DEBUG   ] [viseron.states] - Adding entity Camera 2 Connected from component gstreamer
[2022-11-20 10:22:43] [DEBUG   ] [viseron.states] - Setting state of binary_sensor.camera_2_connected to state: off, attributes {}
[2022-11-20 10:22:43] [DEBUG   ] [viseron.states] - Adding entity Camera 2 Connection from component gstreamer
[2022-11-20 10:22:43] [DEBUG   ] [viseron.states] - Setting state of toggle.camera_2_connection to state: off, attributes {}
[2022-11-20 10:22:43] [DEBUG   ] [viseron.components.mqtt] - Subscribing to topic viseron/toggle/camera_2_connection/command
[2022-11-20 10:22:43] [DEBUG   ] [viseron.components.gstreamer.recorder.camera_2] - Running cleanup
[2022-11-20 10:22:43] [DEBUG   ] [viseron.states] - Adding entity Camera 2 Recorder from component gstreamer
[2022-11-20 10:22:43] [DEBUG   ] [viseron.states] - Setting state of binary_sensor.camera_2_recorder to state: off, attributes {}
[2022-11-20 10:22:43] [DEBUG   ] [viseron.states] - Adding entity Camera 2 Latest Thumbnail from component gstreamer
[2022-11-20 10:22:43] [DEBUG   ] [viseron.states] - Setting state of image.camera_2_latest_thumbnail to state: None, attributes {}
[2022-11-20 10:22:43] [DEBUG   ] [viseron.components.gstreamer.recorder.camera_2] - Initializing gstreamer recorder
[2022-11-20 10:22:43] [DEBUG   ] [viseron.components.gstreamer.camera.camera_2] - Initializing camera Camera 2
[2022-11-20 10:22:43] [DEBUG   ] [viseron.components.gstreamer.stream.camera_2] - Getting stream information for rtsp://*****:*****@10.x.x.x:554/cam/realmonitor?channel=1&subtype=0
[2022-11-20 10:22:43] [DEBUG   ] [viseron.components.gstreamer.stream.camera_2] - FFprobe command: ffprobe -hide_banner -loglevel error -print_format json -show_error -show_streams rtsp://*****:*****@10.x.x.x:554/cam/realmonitor?channel=1&subtype=0
[2022-11-20 10:22:44] [ERROR   ] [viseron.components.gstreamer.stream.camera_2] - [h264 @ 0x55c7e014e0] cabac decode of qscale diff failed at 40 59
[2022-11-20 10:22:46] [DEBUG   ] [viseron.components.gstreamer.stream.camera_2] - Stream information from FFprobe: Width: 3840 Height: 2160 FPS: 15.0 Video Codec: h264 Audio Codec: pcm_alaw
[2022-11-20 10:22:46] [DEBUG   ] [viseron.components.gstreamer.camera.camera_2] - Resolution: 3840x2160 @ 15.0 FPS
[2022-11-20 10:22:46] [DEBUG   ] [viseron.components.gstreamer.camera.camera_2] - Camera Camera 2 initialized
[2022-11-20 10:22:46] [DEBUG   ] [viseron.core] - Registering domain camera with identifier camera_2
[2022-11-20 10:22:46] [INFO    ] [viseron.components] - Setup of domain camera for component gstreamer with identifier camera_2 took 3.1 seconds
[2022-11-20 10:22:46] [DEBUG   ] [viseron.states] - Adding entity Camera 2 Motion Detected from component mog2
[2022-11-20 10:22:46] [DEBUG   ] [viseron.states] - Setting state of binary_sensor.camera_2_motion_detected to state: off, attributes {}
[2022-11-20 10:22:46] [DEBUG   ] [viseron.watchdog] - Registering <RestartableThread(camera_2.motion_detection, initial daemon)> in the watchdog
[2022-11-20 10:22:46] [DEBUG   ] [viseron.core] - Registering domain motion_detector with identifier camera_2
[2022-11-20 10:22:46] [INFO    ] [viseron.components] - Setup of domain motion_detector for component mog2 with identifier camera_2 took 0.0 seconds
[2022-11-20 10:22:46] [DEBUG   ] [viseron.components.nvr.nvr.camera_2] - Initializing NVR for camera Camera 2
[2022-11-20 10:22:46] [INFO    ] [viseron.components.nvr.nvr.camera_2] - Object detector is disabled
[2022-11-20 10:22:46] [DEBUG   ] [viseron.watchdog] - Registering <RestartableThread(<viseron.components.nvr.nvr.NVR object at 0x7f4428f040>, initial)> in the watchdog
[2022-11-20 10:22:46] [DEBUG   ] [viseron.components.nvr.nvr.camera_2] - Waiting for first frame
[2022-11-20 10:22:46] [DEBUG   ] [viseron.states] - Adding entity Camera 2 Operation State from component nvr
[2022-11-20 10:22:46] [DEBUG   ] [viseron.states] - Setting state of sensor.camera_2_operation_state to state: unknown, attributes {}
[2022-11-20 10:22:46] [DEBUG   ] [viseron.components.gstreamer.camera.camera_2] - Starting capture thread
[2022-11-20 10:22:46] [DEBUG   ] [viseron.watchdog] - Registering <RestartableThread(viseron.camera.camera_2, initial daemon)> in the watchdog
[2022-11-20 10:22:46] [DEBUG   ] [viseron.components.gstreamer.stream.camera_2] - GStreamer decoder command: gstreamer_camera_2 --gst-debug-level=1 -q rtspsrc location=rtsp://*****:*****@10.x.x.x:554/cam/realmonitor?channel=1&subtype=0 name=input_stream do-timestamp=true latency=0 protocols=tcp ! rtpjitterbuffer do-lost=true drop-on-latency=true ! rtph264depay ! tee name=depayed_stream ! queue ! nvv4l2decoder enable-max-performance=true drop-frame-interval=1 ! nvvidconv ! video/x-raw,format=(string)NV12 ! fdsink depayed_stream. ! queue ! h264parse ! splitmuxsink async-finalize=true send-keyframe-requests=true max-size-bytes=0 name=mux muxer=mp4mux max-size-time=5000000000 location=/segments/camera_2/%01d.mp4 input_stream. ! queue ! decodebin ! audioconvert ! queue ! voaacenc ! mux.audio_0
[2022-11-20 10:22:46] [INFO    ] [viseron.components.nvr.nvr.camera_2] - NVR for camera Camera 2 initialized
[2022-11-20 10:22:46] [INFO    ] [viseron.components] - Setup of domain nvr for component nvr with identifier camera_2 took 0.0 seconds
[2022-11-20 10:22:46] [DEBUG   ] [viseron.states] - Setting state of toggle.camera_2_connection to state: on, attributes {}
[2022-11-20 10:22:46] [INFO    ] [viseron.core] - Viseron initialized in 4.2 seconds
[2022-11-20 10:22:46] [ERROR   ] [viseron.components.gstreamer.stream.camera_2] - 0:00:00.058635419   417   0x55a56c5730 ERROR           GST_PIPELINE grammar.y:816:priv_gst_parse_yyparse: no element "nvv4l2decoder"
[2022-11-20 10:22:46] [ERROR   ] [viseron.components.gstreamer.stream.camera_2] - 0:00:00.058703026   417   0x55a56c5730 ERROR           GST_PIPELINE grammar.y:901:priv_gst_parse_yyparse: link has no sink [source=@0x55a56cc1b0]
[2022-11-20 10:22:46] [ERROR   ] [viseron.components.gstreamer.stream.camera_2] - 0:00:00.058726464   417   0x55a56c5730 ERROR           GST_PIPELINE grammar.y:816:priv_gst_parse_yyparse: no element "nvvidconv"
[2022-11-20 10:22:46] [ERROR   ] [viseron.components.gstreamer.stream.camera_2] - 0:00:00.058747350   417   0x55a56c5730 ERROR           GST_PIPELINE grammar.y:901:priv_gst_parse_yyparse: link has no source [sink=@(nil)]
[2022-11-20 10:22:46] [ERROR   ] [viseron.components.gstreamer.stream.camera_2] - 0:00:00.058928918   417   0x55a56c5730 ERROR           GST_PIPELINE grammar.y:901:priv_gst_parse_yyparse: link has no source [sink=@0x55a56d09e0]
[2022-11-20 10:22:46] [ERROR   ] [viseron.components.gstreamer.stream.camera_2] - WARNING: erroneous pipeline: no element "nvv4l2decoder"
[2022-11-20 10:22:46] [ERROR   ] [viseron.components.gstreamer.camera.camera_2] - GStreamer process has exited

doesn't look like it is able to initialize the decoder at all but if i do a manual call to the camera it works just fine. very odd but will keep tinkering, thought i'd drop it here in-case anyone else had seen it

"gst-inspect-1.0 nvv4l2decoder" returns normal responses as well.

[roflcoopter]

The builds should be updated yes, did you build it yourself or did you pull it?