search

raspberrypi / rpicam-apps

BSD 2-Clause "Simplified" License
389 stars 212 forks source link

[HELP WANTED] can't start stream on ov5647 sensor on pi 4 with vanilla bullseye #353

Closed routingalchemy closed 2 years ago

routingalchemy commented 2 years ago

Describe the bug Bought a new camera link but I can't get it working neither on my pi3 nor my pi4. I did a fresh 64bit (might be the problem) raspios bullseye install (updated too) on the pi4. Trying to stream video but libcamera-vid sudo libcamera-vid -t 0 --width 640 --height 480 -q 100 -n --codec mjpeg --inline --listen -o tcp://0.0.0.0:8888 -veither quits 

...
Camera started!
Viewfinder frame 0
NetOutput: output buffer 0x7f9c07e010 size 164723
Viewfinder frame 1
NetOutput: output buffer 0x7f880454f0 size 165067
Viewfinder frame 2
NetOutput: output buffer 0x7f880454f0 size 165020
Viewfinder frame 3
NetOutput: output buffer 0x7f84044af0 size 155008
pamacs@raspberrypi:~ $

or crashes.

...
Camera started!
Viewfinder frame 0
NetOutput: output buffer 0x7fa8191010 size 166664
Viewfinder frame 1
Viewfinder frame 2
Viewfinder frame 3
NetOutput: output buffer 0x7fa8150010 size 160749
Viewfinder frame 4
Viewfinder frame 5
NetOutput: output buffer 0x7fa810f010 size 160889
Viewfinder frame 6
NetOutput: output buffer 0x7fa80ce010 size 152098
terminate called after throwing an instance of 'std::runtime_error'
  what():  failed to send data on socket
Aborted
pamacs@raspberrypi:~ $

I can do pictures with the camera and was able to record some video but streaming The networking part I've tried wired and wireless too. (if that counts) Tried a few options before opening the case but the most was a open stream without any picture

Camera started!
Viewfinder frame 0
NetOutput: output buffer 0x7f99d72000 size 460800
Viewfinder frame 1
Viewfinder frame 2
Viewfinder frame 3
NetOutput: output buffer 0x7f99d01000 size 460800
Viewfinder frame 4
Viewfinder frame 5
Viewfinder frame 6
NetOutput: output buffer 0x7f99c90000 size 460800
Viewfinder frame 7
NetOutput: output buffer 0x7f99c1f000 size 460800
Viewfinder frame 8
NetOutput: output buffer 0x7f99bae000 size 460800
Viewfinder frame 9
NetOutput: output buffer 0x7f99b3d000 size 460800
Viewfinder frame 10
NetOutput: output buffer 0x7f99d72000 size 460800
Viewfinder frame 11
NetOutput: output buffer 0x7f99d01000 size 460800
Viewfinder frame 12
NetOutput: output buffer 0x7f99c90000 size 460800
Viewfinder frame 13
NetOutput: output buffer 0x7f99c1f000 size 460800
Viewfinder frame 14
NetOutput: output buffer 0x7f99bae000 size 460800
Viewfinder frame 15
NetOutput: output buffer 0x7f99b3d000 size 460800
Viewfinder frame 16
NetOutput: output buffer 0x7f99d72000 size 460800
Viewfinder frame 17
NetOutput: output buffer 0x7f99d01000 size 460800
Viewfinder frame 18
NetOutput: output buffer 0x7f99c90000 size 460800
Viewfinder frame 19
NetOutput: output buffer 0x7f99c1f000 size 460800
Viewfinder frame 20
...

Is it something obvious or something is not right?

Thx

Bug report

pamacs@raspberrypi:~ $ cat bug.txt
--------------------------------------------------------------------------------
libcamera-apps Bug Report
--------------------------------------------------------------------------------
Date: 31-08-2022 (14:54:10)
Command: /usr/bin/camera-bug-report -o bug.txt -c libcamera-vid -t 0 --width 640 --height 480 -q 100 -n  --inline --codec mjpeg --listen -o tcp://0.0.0.0:8888 -v

--------------------------------------------------------------------------------
Hardware information
--------------------------------------------------------------------------------
** hostname **
raspberrypi

** cat /proc/cpuinfo **
processor       : 0
BogoMIPS        : 108.00
Features        : fp asimd evtstrm crc32 cpuid
CPU implementer : 0x41
CPU architecture: 8
CPU variant     : 0x0
CPU part        : 0xd08
CPU revision    : 3

processor       : 1
BogoMIPS        : 108.00
Features        : fp asimd evtstrm crc32 cpuid
CPU implementer : 0x41
CPU architecture: 8
CPU variant     : 0x0
CPU part        : 0xd08
CPU revision    : 3

processor       : 2
BogoMIPS        : 108.00
Features        : fp asimd evtstrm crc32 cpuid
CPU implementer : 0x41
CPU architecture: 8
CPU variant     : 0x0
CPU part        : 0xd08
CPU revision    : 3

processor       : 3
BogoMIPS        : 108.00
Features        : fp asimd evtstrm crc32 cpuid
CPU implementer : 0x41
CPU architecture: 8
CPU variant     : 0x0
CPU part        : 0xd08
CPU revision    : 3

Hardware        : BCM2835
Revision        : b03112
Serial          : 10000000cfdd4cd7
Model           : Raspberry Pi 4 Model B Rev 1.2

--------------------------------------------------------------------------------
Configuration
--------------------------------------------------------------------------------
** cat /boot/cmdline.txt **
console=serial0,115200 console=tty1 root=PARTUUID=d3fa126c-02 rootfstype=ext4 fsck.repair=yes rootwait

** cat /boot/config.txt **
# For more options and information see
# http://rpf.io/configtxt
# Some settings may impact device functionality. See link above for details

# uncomment if you get no picture on HDMI for a default "safe" mode
#hdmi_safe=1

# uncomment the following to adjust overscan. Use positive numbers if console
# goes off screen, and negative if there is too much border
#overscan_left=16
#overscan_right=16
#overscan_top=16
#overscan_bottom=16

# uncomment to force a console size. By default it will be display's size minus
# overscan.
#framebuffer_width=1280
#framebuffer_height=720

# uncomment if hdmi display is not detected and composite is being output
#hdmi_force_hotplug=1

# uncomment to force a specific HDMI mode (this will force VGA)
#hdmi_group=1
#hdmi_mode=1

# uncomment to force a HDMI mode rather than DVI. This can make audio work in
# DMT (computer monitor) modes
#hdmi_drive=2

# uncomment to increase signal to HDMI, if you have interference, blanking, or
# no display
#config_hdmi_boost=4

# uncomment for composite PAL
#sdtv_mode=2

#uncomment to overclock the arm. 700 MHz is the default.
#arm_freq=800

# Uncomment some or all of these to enable the optional hardware interfaces
dtparam=i2c_arm=on
dtparam=i2s=on
dtparam=spi=on

# Uncomment this to enable infrared communication.
#dtoverlay=gpio-ir,gpio_pin=17
#dtoverlay=gpio-ir-tx,gpio_pin=18

# Additional overlays and parameters are documented /boot/overlays/README

# Enable audio (loads snd_bcm2835)
dtparam=audio=on

# Automatically load overlays for detected cameras
start_x=1

# Automatically load overlays for detected DSI displays
display_auto_detect=1

# Enable DRM VC4 V3D driver
#dtoverlay=vc4-kms-v3d
max_framebuffers=2

# Run in 64-bit mode
arm_64bit=1

# Disable compensation for displays with overscan
disable_overscan=1

[cm4]
# Enable host mode on the 2711 built-in XHCI USB controller.
# This line should be removed if the legacy DWC2 controller is required
# (e.g. for USB device mode) or if USB support is not required.
otg_mode=1

[all]

[pi4]
dtoverlay=vc4-fkms-v3d
# Run as fast as firmware / board allows
arm_boost=1

[all]
gpu_mem=128
dtoverlay=ov5647
camera_auto_detect=1

--------------------------------------------------------------------------------
Logs
--------------------------------------------------------------------------------
** dmesg **
[    0.000000] Booting Linux on physical CPU 0x0000000000 [0x410fd083]
[    0.000000] Linux version 5.15.32-v8+ (dom@buildbot) (aarch64-linux-gnu-gcc-8 (Ubuntu/Linaro 8.4.0-3ubuntu1) 8.4.0, GNU ld (GNU Binutils for Ubuntu) 2.34) #1538 SMP PREEMPT Thu Mar 31 19:40:39 BST 2022
[    0.000000] random: fast init done
[    0.000000] Machine model: Raspberry Pi 4 Model B Rev 1.2
[    0.000000] efi: UEFI not found.
[    0.000000] Reserved memory: created CMA memory pool at 0x000000001ac00000, size 320 MiB
[    0.000000] OF: reserved mem: initialized node linux,cma, compatible id shared-dma-pool
[    0.000000] Zone ranges:
[    0.000000]   DMA      [mem 0x0000000000000000-0x000000003fffffff]
[    0.000000]   DMA32    [mem 0x0000000040000000-0x000000007fffffff]
[    0.000000]   Normal   empty
[    0.000000] Movable zone start for each node
[    0.000000] Early memory node ranges
[    0.000000]   node   0: [mem 0x0000000000000000-0x0000000037ffffff]
[    0.000000]   node   0: [mem 0x0000000040000000-0x000000007fffffff]
[    0.000000] Initmem setup node 0 [mem 0x0000000000000000-0x000000007fffffff]
[    0.000000] percpu: Embedded 28 pages/cpu s77144 r8192 d29352 u114688
[    0.000000] pcpu-alloc: s77144 r8192 d29352 u114688 alloc=28*4096
[    0.000000] pcpu-alloc: [0] 0 [0] 1 [0] 2 [0] 3
[    0.000000] Detected PIPT I-cache on CPU0
[    0.000000] CPU features: detected: Spectre-v2
[    0.000000] CPU features: detected: Spectre-v4
[    0.000000] CPU features: detected: Spectre-BHB
[    0.000000] CPU features: detected: ARM errata 1165522, 1319367, or 1530923
[    0.000000] Built 1 zonelists, mobility grouping on.  Total pages: 483840
[    0.000000] Kernel command line: coherent_pool=1M 8250.nr_uarts=0 snd_bcm2835.enable_compat_alsa=0 snd_bcm2835.enable_hdmi=1 video=HDMI-A-1:3840x2160M@30 smsc95xx.macaddr=DC:A6:32:B3:12:BC vc_mem.mem_base=0x3ec00000 vc_mem.mem_size=0x40000000  console=ttyS0,115200 console=tty1 root=PARTUUID=d3fa126c-02 rootfstype=ext4 fsck.repair=yes rootwait
[    0.000000] Dentry cache hash table entries: 262144 (order: 9, 2097152 bytes, linear)
[    0.000000] Inode-cache hash table entries: 131072 (order: 8, 1048576 bytes, linear)
[    0.000000] mem auto-init: stack:off, heap alloc:off, heap free:off
[    0.000000] software IO TLB: mapped [mem 0x0000000034000000-0x0000000038000000] (64MB)
[    0.000000] Memory: 1511196K/1966080K available (11456K kernel code, 1962K rwdata, 4144K rodata, 3776K init, 964K bss, 127204K reserved, 327680K cma-reserved)
[    0.000000] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=4, Nodes=1
[    0.000000] ftrace: allocating 37889 entries in 149 pages
[    0.000000] ftrace: allocated 149 pages with 4 groups
[    0.000000] trace event string verifier disabled
[    0.000000] rcu: Preemptible hierarchical RCU implementation.
[    0.000000] rcu:     RCU event tracing is enabled.
[    0.000000] rcu:     RCU restricting CPUs from NR_CPUS=256 to nr_cpu_ids=4.
[    0.000000]  Trampoline variant of Tasks RCU enabled.
[    0.000000]  Rude variant of Tasks RCU enabled.
[    0.000000]  Tracing variant of Tasks RCU enabled.
[    0.000000] rcu: RCU calculated value of scheduler-enlistment delay is 25 jiffies.
[    0.000000] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=4
[    0.000000] NR_IRQS: 64, nr_irqs: 64, preallocated irqs: 0
[    0.000000] Root IRQ handler: gic_handle_irq
[    0.000000] GIC: Using split EOI/Deactivate mode
[    0.000000] random: get_random_bytes called from start_kernel+0x510/0x6f8 with crng_init=1
[    0.000000] arch_timer: cp15 timer(s) running at 54.00MHz (phys).
[    0.000000] clocksource: arch_sys_counter: mask: 0xffffffffffffff max_cycles: 0xc743ce346, max_idle_ns: 440795203123 ns
[    0.000001] sched_clock: 56 bits at 54MHz, resolution 18ns, wraps every 4398046511102ns
[    0.000252] Console: colour dummy device 80x25
[    0.000782] printk: console [tty1] enabled
[    0.000852] Calibrating delay loop (skipped), value calculated using timer frequency.. 108.00 BogoMIPS (lpj=216000)
[    0.000893] pid_max: default: 32768 minimum: 301
[    0.001038] LSM: Security Framework initializing
[    0.001190] Mount-cache hash table entries: 4096 (order: 3, 32768 bytes, linear)
[    0.001243] Mountpoint-cache hash table entries: 4096 (order: 3, 32768 bytes, linear)
[    0.002485] cgroup: Disabling memory control group subsystem
[    0.004899] rcu: Hierarchical SRCU implementation.
[    0.006017] EFI services will not be available.
[    0.006548] smp: Bringing up secondary CPUs ...
[    0.007570] Detected PIPT I-cache on CPU1
[    0.007647] CPU1: Booted secondary processor 0x0000000001 [0x410fd083]
[    0.008869] Detected PIPT I-cache on CPU2
[    0.008919] CPU2: Booted secondary processor 0x0000000002 [0x410fd083]
[    0.010008] Detected PIPT I-cache on CPU3
[    0.010058] CPU3: Booted secondary processor 0x0000000003 [0x410fd083]
[    0.010206] smp: Brought up 1 node, 4 CPUs
[    0.010297] SMP: Total of 4 processors activated.
[    0.010319] CPU features: detected: 32-bit EL0 Support
[    0.010338] CPU features: detected: 32-bit EL1 Support
[    0.010359] CPU features: detected: CRC32 instructions
[    0.041405] CPU: All CPU(s) started at EL2
[    0.041498] alternatives: patching kernel code
[    0.042991] devtmpfs: initialized
[    0.054035] Enabled cp15_barrier support
[    0.054101] Enabled setend support
[    0.054303] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 7645041785100000 ns
[    0.054352] futex hash table entries: 1024 (order: 4, 65536 bytes, linear)
[    0.064950] pinctrl core: initialized pinctrl subsystem
[    0.065809] DMI not present or invalid.
[    0.066298] NET: Registered PF_NETLINK/PF_ROUTE protocol family
[    0.069915] DMA: preallocated 1024 KiB GFP_KERNEL pool for atomic allocations
[    0.070229] DMA: preallocated 1024 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations
[    0.071150] DMA: preallocated 1024 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations
[    0.071258] audit: initializing netlink subsys (disabled)
[    0.071559] audit: type=2000 audit(0.068:1): state=initialized audit_enabled=0 res=1
[    0.072064] thermal_sys: Registered thermal governor 'step_wise'
[    0.072318] cpuidle: using governor menu
[    0.072636] hw-breakpoint: found 6 breakpoint and 4 watchpoint registers.
[    0.072834] ASID allocator initialised with 65536 entries
[    0.073012] Serial: AMBA PL011 UART driver
[    0.084769] bcm2835-mbox fe00b880.mailbox: mailbox enabled
[    0.108317] raspberrypi-firmware soc:firmware: Attached to firmware from 2022-03-24T13:20:19, variant start_x
[    0.112336] raspberrypi-firmware soc:firmware: Firmware hash is e5a963efa66a1974127860b42e913d2374139ff5
[    0.163776] bcm2835-dma fe007000.dma: DMA legacy API manager, dmachans=0x1
[    0.168026] vgaarb: loaded
[    0.168441] SCSI subsystem initialized
[    0.168777] usbcore: registered new interface driver usbfs
[    0.168856] usbcore: registered new interface driver hub
[    0.168933] usbcore: registered new device driver usb
[    0.169279] usb_phy_generic phy: supply vcc not found, using dummy regulator
[    0.169749] pps_core: LinuxPPS API ver. 1 registered
[    0.169774] pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti <giometti@linux.it>
[    0.169812] PTP clock support registered
[    0.171262] clocksource: Switched to clocksource arch_sys_counter
[    0.259813] VFS: Disk quotas dquot_6.6.0
[    0.259940] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes)
[    0.260129] FS-Cache: Loaded
[    0.260374] CacheFiles: Loaded
[    0.261702] simple-framebuffer 3e267000.framebuffer: framebuffer at 0x3e267000, 0x960000 bytes
[    0.261739] simple-framebuffer 3e267000.framebuffer: format=a8r8g8b8, mode=1920x1280x32, linelength=7680
[    0.275307] Console: switching to colour frame buffer device 240x80
[    0.287805] simple-framebuffer 3e267000.framebuffer: fb0: simplefb registered!
[    0.298292] NET: Registered PF_INET protocol family
[    0.298671] IP idents hash table entries: 32768 (order: 6, 262144 bytes, linear)
[    0.300927] tcp_listen_portaddr_hash hash table entries: 1024 (order: 2, 16384 bytes, linear)
[    0.301055] TCP established hash table entries: 16384 (order: 5, 131072 bytes, linear)
[    0.301243] TCP bind hash table entries: 16384 (order: 6, 262144 bytes, linear)
[    0.301561] TCP: Hash tables configured (established 16384 bind 16384)
[    0.301836] UDP hash table entries: 1024 (order: 3, 32768 bytes, linear)
[    0.301947] UDP-Lite hash table entries: 1024 (order: 3, 32768 bytes, linear)
[    0.302272] NET: Registered PF_UNIX/PF_LOCAL protocol family
[    0.303301] RPC: Registered named UNIX socket transport module.
[    0.303382] RPC: Registered udp transport module.
[    0.303441] RPC: Registered tcp transport module.
[    0.303499] RPC: Registered tcp NFSv4.1 backchannel transport module.
[    0.303582] PCI: CLS 0 bytes, default 64
[    0.305947] hw perfevents: enabled with armv8_cortex_a72 PMU driver, 7 counters available
[    0.306385] kvm [1]: IPA Size Limit: 44 bits
[    0.307618] kvm [1]: vgic interrupt IRQ9
[    0.307932] kvm [1]: Hyp mode initialized successfully
[    1.184159] Initialise system trusted keyrings
[    1.184555] workingset: timestamp_bits=46 max_order=19 bucket_order=0
[    1.191350] zbud: loaded
[    1.193152] FS-Cache: Netfs 'nfs' registered for caching
[    1.193921] NFS: Registering the id_resolver key type
[    1.194021] Key type id_resolver registered
[    1.194078] Key type id_legacy registered
[    1.194247] nfs4filelayout_init: NFSv4 File Layout Driver Registering...
[    1.194329] nfs4flexfilelayout_init: NFSv4 Flexfile Layout Driver Registering...
[    1.195597] Key type asymmetric registered
[    1.195661] Asymmetric key parser 'x509' registered
[    1.195801] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 247)
[    1.196163] io scheduler mq-deadline registered
[    1.196227] io scheduler kyber registered
[    1.204112] brcm-pcie fd500000.pcie: host bridge /scb/pcie@7d500000 ranges:
[    1.204233] brcm-pcie fd500000.pcie:   No bus range found for /scb/pcie@7d500000, using [bus 00-ff]
[    1.204405] brcm-pcie fd500000.pcie:      MEM 0x0600000000..0x063fffffff -> 0x00c0000000
[    1.204566] brcm-pcie fd500000.pcie:   IB MEM 0x0000000000..0x007fffffff -> 0x0400000000
[    1.253359] brcm-pcie fd500000.pcie: link up, 5.0 GT/s PCIe x1 (SSC)
[    1.253805] brcm-pcie fd500000.pcie: PCI host bridge to bus 0000:00
[    1.253888] pci_bus 0000:00: root bus resource [bus 00-ff]
[    1.253962] pci_bus 0000:00: root bus resource [mem 0x600000000-0x63fffffff] (bus address [0xc0000000-0xffffffff])
[    1.254145] pci 0000:00:00.0: [14e4:2711] type 01 class 0x060400
[    1.254452] pci 0000:00:00.0: PME# supported from D0 D3hot
[    1.258381] pci 0000:00:00.0: bridge configuration invalid ([bus 00-00]), reconfiguring
[    1.258815] pci 0000:01:00.0: [1106:3483] type 00 class 0x0c0330
[    1.259000] pci 0000:01:00.0: reg 0x10: [mem 0x00000000-0x00000fff 64bit]
[    1.259537] pci 0000:01:00.0: PME# supported from D0 D3cold
[    1.274736] pci_bus 0000:01: busn_res: [bus 01-ff] end is updated to 01
[    1.274849] pci 0000:00:00.0: BAR 8: assigned [mem 0x600000000-0x6000fffff]
[    1.274942] pci 0000:01:00.0: BAR 0: assigned [mem 0x600000000-0x600000fff 64bit]
[    1.278366] pci 0000:00:00.0: PCI bridge to [bus 01]
[    1.281769] pci 0000:00:00.0:   bridge window [mem 0x600000000-0x6000fffff]
[    1.293455] iproc-rng200 fe104000.rng: hwrng registered
[    1.297338] vc-mem: phys_addr:0x00000000 mem_base=0x3ec00000 mem_size:0x40000000(1024 MiB)
[    1.302073] gpiomem-bcm2835 fe200000.gpiomem: Initialised: Registers at 0xfe200000
[    1.305841] cacheinfo: Unable to detect cache hierarchy for CPU 0
[    1.320091] brd: module loaded
[    1.332995] loop: module loaded
[    1.337148] Loading iSCSI transport class v2.0-870.
[    1.345471] bcmgenet fd580000.ethernet: GENET 5.0 EPHY: 0x0000
[    1.407418] unimac-mdio unimac-mdio.-19: Broadcom UniMAC MDIO bus
[    1.411934] usbcore: registered new interface driver r8152
[    1.415407] usbcore: registered new interface driver lan78xx
[    1.418762] usbcore: registered new interface driver smsc95xx
[    1.423599] pci 0000:00:00.0: enabling device (0000 -> 0002)
[    1.426917] xhci_hcd 0000:01:00.0: enabling device (0000 -> 0002)
[    1.430332] xhci_hcd 0000:01:00.0: xHCI Host Controller
[    1.433647] xhci_hcd 0000:01:00.0: new USB bus registered, assigned bus number 1
[    1.437651] xhci_hcd 0000:01:00.0: hcc params 0x002841eb hci version 0x100 quirks 0x00003c0000000890
[    1.442300] usb usb1: New USB device found, idVendor=1d6b, idProduct=0002, bcdDevice= 5.15
[    1.445672] usb usb1: New USB device strings: Mfr=3, Product=2, SerialNumber=1
[    1.449011] usb usb1: Product: xHCI Host Controller
[    1.452301] usb usb1: Manufacturer: Linux 5.15.32-v8+ xhci-hcd
[    1.455587] usb usb1: SerialNumber: 0000:01:00.0
[    1.459591] hub 1-0:1.0: USB hub found
[    1.462883] hub 1-0:1.0: 1 port detected
[    1.466720] xhci_hcd 0000:01:00.0: xHCI Host Controller
[    1.469926] xhci_hcd 0000:01:00.0: new USB bus registered, assigned bus number 2
[    1.473125] xhci_hcd 0000:01:00.0: Host supports USB 3.0 SuperSpeed
[    1.476754] usb usb2: New USB device found, idVendor=1d6b, idProduct=0003, bcdDevice= 5.15
[    1.479927] usb usb2: New USB device strings: Mfr=3, Product=2, SerialNumber=1
[    1.483073] usb usb2: Product: xHCI Host Controller
[    1.486251] usb usb2: Manufacturer: Linux 5.15.32-v8+ xhci-hcd
[    1.489544] usb usb2: SerialNumber: 0000:01:00.0
[    1.493338] hub 2-0:1.0: USB hub found
[    1.496526] hub 2-0:1.0: 4 ports detected
[    1.501249] dwc_otg: version 3.00a 10-AUG-2012 (platform bus)
[    1.504691] dwc_otg: FIQ enabled
[    1.504703] dwc_otg: NAK holdoff enabled
[    1.504712] dwc_otg: FIQ split-transaction FSM enabled
[    1.504725] Module dwc_common_port init
[    1.505300] usbcore: registered new interface driver uas
[    1.508534] usbcore: registered new interface driver usb-storage
[    1.511879] mousedev: PS/2 mouse device common for all mice
[    1.519817] sdhci: Secure Digital Host Controller Interface driver
[    1.522904] sdhci: Copyright(c) Pierre Ossman
[    1.526584] sdhci-pltfm: SDHCI platform and OF driver helper
[    1.533104] ledtrig-cpu: registered to indicate activity on CPUs
[    1.536813] hid: raw HID events driver (C) Jiri Kosina
[    1.540074] usbcore: registered new interface driver usbhid
[    1.543151] usbhid: USB HID core driver
[    1.546540] ashmem: initialized
[    1.557825] Initializing XFRM netlink socket
[    1.560994] NET: Registered PF_PACKET protocol family
[    1.564296] Key type dns_resolver registered
[    1.568505] registered taskstats version 1
[    1.571604] Loading compiled-in X.509 certificates
[    1.575308] Key type ._fscrypt registered
[    1.578333] Key type .fscrypt registered
[    1.581328] Key type fscrypt-provisioning registered
[    1.595834] uart-pl011 fe201000.serial: there is not valid maps for state default
[    1.599189] uart-pl011 fe201000.serial: cts_event_workaround enabled
[    1.602357] fe201000.serial: ttyAMA0 at MMIO 0xfe201000 (irq = 17, base_baud = 0) is a PL011 rev2
[    1.614191] bcm2835-wdt bcm2835-wdt: Broadcom BCM2835 watchdog timer
[    1.617747] bcm2835-power bcm2835-power: Broadcom BCM2835 power domains driver
[    1.621984] mmc-bcm2835 fe300000.mmcnr: mmc_debug:0 mmc_debug2:0
[    1.625089] mmc-bcm2835 fe300000.mmcnr: DMA channel allocated
[    1.660324] of_cfs_init
[    1.663635] of_cfs_init: OK
[    1.697700] mmc0: SDHCI controller on fe340000.mmc [fe340000.mmc] using ADMA
[    1.701284] Waiting for root device PARTUUID=d3fa126c-02...
[    1.719306] usb 1-1: new high-speed USB device number 2 using xhci_hcd
[    1.755692] mmc1: new high speed SDIO card at address 0001
[    1.803526] mmc0: new ultra high speed DDR50 SDHC card at address aaaa
[    1.807572] mmcblk0: mmc0:aaaa SC32G 29.7 GiB
[    1.816561]  mmcblk0: p1 p2
[    1.820165] mmcblk0: mmc0:aaaa SC32G 29.7 GiB
[    1.843294] EXT4-fs (mmcblk0p2): mounted filesystem with ordered data mode. Opts: (null). Quota mode: none.
[    1.846522] VFS: Mounted root (ext4 filesystem) readonly on device 179:2.
[    1.856903] devtmpfs: mounted
[    1.867585] Freeing unused kernel memory: 3776K
[    1.869991] usb 1-1: New USB device found, idVendor=2109, idProduct=3431, bcdDevice= 4.21
[    1.870900] Run /sbin/init as init process
[    1.873852] usb 1-1: New USB device strings: Mfr=0, Product=1, SerialNumber=0
[    1.876916]   with arguments:
[    1.876925]     /sbin/init
[    1.880012] usb 1-1: Product: USB2.0 Hub
[    1.880016]   with environment:
[    1.881734] hub 1-1:1.0: USB hub found
[    1.883197]     HOME=/
[    1.886171]     TERM=linux
[    1.886642] hub 1-1:1.0: 4 ports detected
[    2.235628] systemd[1]: System time before build time, advancing clock.
[    2.329109] NET: Registered PF_INET6 protocol family
[    2.334076] Segment Routing with IPv6
[    2.337223] In-situ OAM (IOAM) with IPv6
[    2.393192] systemd[1]: systemd 247.3-7 running in system mode. (+PAM +AUDIT +SELINUX +IMA +APPARMOR +SMACK +SYSVINIT +UTMP +LIBCRYPTSETUP +GCRYPT +GNUTLS +ACL +XZ +LZ4 +ZSTD +SECCOMP +BLKID +ELFUTILS +KMOD +IDN2 -IDN +PCRE2 default-hierarchy=unified)
[    2.400827] systemd[1]: Detected architecture arm64.
[    2.425184] systemd[1]: Set hostname to <raspberrypi>.
[    3.056357] systemd[1]: Queued start job for default target Multi-User System.
[    3.063800] random: systemd: uninitialized urandom read (16 bytes read)
[    3.069415] systemd[1]: Created slice system-getty.slice.
[    3.077022] random: systemd: uninitialized urandom read (16 bytes read)
[    3.081488] systemd[1]: Created slice system-modprobe.slice.
[    3.088792] random: systemd: uninitialized urandom read (16 bytes read)
[    3.093244] systemd[1]: Created slice system-systemd\x2dfsck.slice.
[    3.101338] systemd[1]: Created slice User and Session Slice.
[    3.109140] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.
[    3.116917] systemd[1]: Started Forward Password Requests to Wall Directory Watch.
[    3.125478] systemd[1]: Set up automount Arbitrary Executable File Formats File System Automount Point.
[    3.133432] systemd[1]: Reached target Local Encrypted Volumes.
[    3.141368] systemd[1]: Reached target Paths.
[    3.149210] systemd[1]: Reached target Slices.
[    3.157011] systemd[1]: Reached target Swap.
[    3.165615] systemd[1]: Listening on Syslog Socket.
[    3.174073] systemd[1]: Listening on fsck to fsckd communication Socket.
[    3.182271] systemd[1]: Listening on initctl Compatibility Named Pipe.
[    3.191385] systemd[1]: Listening on Journal Audit Socket.
[    3.200096] systemd[1]: Listening on Journal Socket (/dev/log).
[    3.209075] systemd[1]: Listening on Journal Socket.
[    3.220838] systemd[1]: Listening on udev Control Socket.
[    3.229659] systemd[1]: Listening on udev Kernel Socket.
[    3.238555] systemd[1]: Condition check resulted in Huge Pages File System being skipped.
[    3.246376] systemd[1]: Mounting POSIX Message Queue File System...
[    3.258852] systemd[1]: Mounting RPC Pipe File System...
[    3.272064] systemd[1]: Mounting Kernel Debug File System...
[    3.285250] systemd[1]: Mounting Kernel Trace File System...
[    3.294001] systemd[1]: Condition check resulted in Kernel Module supporting RPCSEC_GSS being skipped.
[    3.305445] systemd[1]: Starting Restore / save the current clock...
[    3.319091] systemd[1]: Starting Set the console keyboard layout...
[    3.332846] systemd[1]: Starting Create list of static device nodes for the current kernel...
[    3.346577] systemd[1]: Starting Load Kernel Module configfs...
[    3.361584] systemd[1]: Starting Load Kernel Module drm...
[    3.376808] systemd[1]: Starting Load Kernel Module fuse...
[    3.389825] systemd[1]: Condition check resulted in Set Up Additional Binary Formats being skipped.
[    3.399583] systemd[1]: Starting File System Check on Root Device...
[    3.419653] systemd[1]: Starting Journal Service...
[    3.437307] systemd[1]: Starting Load Kernel Modules...
[    3.451421] systemd[1]: Starting Coldplug All udev Devices...
[    3.453649] fuse: init (API version 7.34)
[    3.487821] systemd[1]: Mounted POSIX Message Queue File System.
[    3.497988] systemd[1]: Mounted RPC Pipe File System.
[    3.508286] systemd[1]: Mounted Kernel Debug File System.
[    3.517832] systemd[1]: Mounted Kernel Trace File System.
[    3.529187] systemd[1]: Finished Restore / save the current clock.
[    3.540131] systemd[1]: Finished Create list of static device nodes for the current kernel.
[    3.550907] systemd[1]: modprobe@configfs.service: Succeeded.
[    3.556938] systemd[1]: Finished Load Kernel Module configfs.
[    3.568069] systemd[1]: modprobe@drm.service: Succeeded.
[    3.574214] systemd[1]: Finished Load Kernel Module drm.
[    3.585459] systemd[1]: modprobe@fuse.service: Succeeded.
[    3.590872] systemd[1]: Finished Load Kernel Module fuse.
[    3.601173] systemd[1]: Finished Load Kernel Modules.
[    3.616826] systemd[1]: Mounting FUSE Control File System...
[    3.638769] systemd[1]: Mounting Kernel Configuration File System...
[    3.660215] systemd[1]: Started File System Check Daemon to report status.
[    3.700045] systemd[1]: Starting Apply Kernel Variables...
[    3.713253] systemd[1]: Mounted FUSE Control File System.
[    3.723822] systemd[1]: Finished File System Check on Root Device.
[    3.732783] systemd[1]: Mounted Kernel Configuration File System.
[    3.745647] systemd[1]: Starting Remount Root and Kernel File Systems...
[    3.754850] systemd[1]: Started Journal Service.
[    3.880229] EXT4-fs (mmcblk0p2): re-mounted. Opts: (null). Quota mode: none.
[    3.936413] systemd-journald[141]: Received client request to flush runtime journal.
[    3.949872] systemd-journald[141]: File /var/log/journal/47306d48ac974bb5a914bc4cf3c047ed/system.journal corrupted or uncleanly shut down, renaming and replacing.
[    4.840581] rpivid-mem feb00000.hevc-decoder: rpivid-hevcmem initialised: Registers at 0xfeb00000 length 0x00010000
[    4.848171] rpivid-mem feb10000.rpivid-local-intc: rpivid-intcmem initialised: Registers at 0xfeb10000 length 0x00001000
[    4.881477] rpivid-mem feb20000.h264-decoder: rpivid-h264mem initialised: Registers at 0xfeb20000 length 0x00010000
[    4.903943] rpivid-mem feb30000.vp9-decoder: rpivid-vp9mem initialised: Registers at 0xfeb30000 length 0x00010000
[    4.947636] vc_sm_cma: module is from the staging directory, the quality is unknown, you have been warned.
[    4.949388] bcm2835_vc_sm_cma_probe: Videocore shared memory driver
[    4.949424] [vc_sm_connected_init]: start
[    4.950849] [vc_sm_connected_init]: installed successfully
[    4.955403] snd_bcm2835: module is from the staging directory, the quality is unknown, you have been warned.
[    4.991033] bcm2835_audio bcm2835_audio: card created with 4 channels
[    4.999683] mc: Linux media interface: v0.10
[    5.002220] bcm2835_audio bcm2835_audio: card created with 4 channels
[    5.038924] videodev: Linux video capture interface: v2.00
[    5.204069] i2c i2c-22: Added multiplexed i2c bus 0
[    5.207561] i2c 10-0036: Fixing up cyclic dependency with fe801000.csi
[    5.208389] i2c i2c-22: Added multiplexed i2c bus 10
[    5.232264] bcm2835_mmal_vchiq: module is from the staging directory, the quality is unknown, you have been warned.
[    5.234702] bcm2835_mmal_vchiq: module is from the staging directory, the quality is unknown, you have been warned.
[    5.239024] bcm2835_v4l2: module is from the staging directory, the quality is unknown, you have been warned.
[    5.246030] bcm2835_codec: module is from the staging directory, the quality is unknown, you have been warned.
[    5.252253] bcm2835_isp: module is from the staging directory, the quality is unknown, you have been warned.
[    5.257314] bcm2835-codec bcm2835-codec: Device registered as /dev/video10
[    5.257393] bcm2835-codec bcm2835-codec: Loaded V4L2 decode
[    5.272241] bcm2835-isp bcm2835-isp: Device node output[0] registered as /dev/video13
[    5.272908] bcm2835-isp bcm2835-isp: Device node capture[0] registered as /dev/video14
[    5.273557] bcm2835-isp bcm2835-isp: Device node capture[1] registered as /dev/video15
[    5.277523] bcm2835-codec bcm2835-codec: Device registered as /dev/video11
[    5.277593] bcm2835-codec bcm2835-codec: Loaded V4L2 encode
[    5.282345] checking generic (3e267000 960000) vs hw (0 ffffffffffffffff)
[    5.282376] fb0: switching to vc4 from simple
[    5.284267] Console: switching to colour dummy device 80x25
[    5.286523] vc4-drm gpu: bound fe600000.firmwarekms (ops vc4_fkms_ops [vc4])
[    5.286904] bcm2835-codec bcm2835-codec: Device registered as /dev/video12
[    5.286947] bcm2835-codec bcm2835-codec: Loaded V4L2 isp
[    5.292380] bcm2835-isp bcm2835-isp: Device node stats[2] registered as /dev/video16
[    5.292467] bcm2835-isp bcm2835-isp: Register output node 0 with media controller
[    5.292492] bcm2835-isp bcm2835-isp: Register capture node 1 with media controller
[    5.292511] bcm2835-isp bcm2835-isp: Register capture node 2 with media controller
[    5.292529] bcm2835-isp bcm2835-isp: Register capture node 3 with media controller
[    5.293094] bcm2835-codec bcm2835-codec: Device registered as /dev/video18
[    5.293138] bcm2835-codec bcm2835-codec: Loaded V4L2 image_fx
[    5.300324] bcm2835-isp bcm2835-isp: Device node output[0] registered as /dev/video20
[    5.303778] bcm2835-isp bcm2835-isp: Device node capture[0] registered as /dev/video21
[    5.304332] [drm] Initialized vc4 0.0.0 20140616 for gpu on minor 0
[    5.304456] bcm2835-isp bcm2835-isp: Device node capture[1] registered as /dev/video22
[    5.306223] bcm2835-codec bcm2835-codec: Device registered as /dev/video31
[    5.306277] bcm2835-codec bcm2835-codec: Loaded V4L2 encode_image
[    5.309365] bcm2835-isp bcm2835-isp: Device node stats[2] registered as /dev/video23
[    5.309412] bcm2835-isp bcm2835-isp: Register output node 0 with media controller
[    5.309434] bcm2835-isp bcm2835-isp: Register capture node 1 with media controller
[    5.309453] bcm2835-isp bcm2835-isp: Register capture node 2 with media controller
[    5.309482] bcm2835-isp bcm2835-isp: Register capture node 3 with media controller
[    5.309906] bcm2835-isp bcm2835-isp: Loaded V4L2 bcm2835-isp
[    5.428723] [drm] Initialized v3d 1.0.0 20180419 for fec00000.v3d on minor 1
[    5.441811] cfg80211: Loading compiled-in X.509 certificates for regulatory database
[    5.485903] cfg80211: Loaded X.509 cert 'sforshee: 00b28ddf47aef9cea7'
[    5.520814] cfg80211: loaded regulatory.db is malformed or signature is missing/invalid
[    5.556613] brcmfmac: F1 signature read @0x18000000=0x15264345
[    5.571758] brcmfmac: brcmf_fw_alloc_request: using brcm/brcmfmac43455-sdio for chip BCM4345/6
[    5.572603] brcmfmac mmc1:0001:1: Direct firmware load for brcm/brcmfmac43455-sdio.raspberrypi,4-model-b.bin failed with error -2
[    5.573106] usbcore: registered new interface driver brcmfmac
[    5.625044] Console: switching to colour frame buffer device 480x135
[    5.746613] vc4-drm gpu: [drm] fb0: vc4drmfb frame buffer device
[    5.821539] brcmfmac: brcmf_fw_alloc_request: using brcm/brcmfmac43455-sdio for chip BCM4345/6
[    5.821740] brcmfmac: brcmf_fw_alloc_request: using brcm/brcmfmac43455-sdio for chip BCM4345/6
[    5.830300] brcmfmac: brcmf_c_preinit_dcmds: Firmware: BCM4345/6 wl0: Nov  1 2021 00:37:25 version 7.45.241 (1a2f2fa CY) FWID 01-703fd60
[    5.951340] random: crng init done
[    5.951370] random: 7 urandom warning(s) missed due to ratelimiting
[    6.566821] ov5647 10-0036: Consider updating driver ov5647 to match on endpoints
[    6.800379] uart-pl011 fe201000.serial: no DMA platform data
[    6.843472] 8021q: 802.1Q VLAN Support v1.8
[    6.987180] Adding 102396k swap on /var/swap.  Priority:-2 extents:3 across:126976k SSFS
[    7.153654] brcmfmac: brcmf_cfg80211_set_power_mgmt: power save enabled
[    7.323722] bcmgenet fd580000.ethernet: configuring instance for external RGMII (RX delay)
[    7.323984] bcmgenet fd580000.ethernet eth0: Link is Down
[   12.525673] IPv6: ADDRCONF(NETDEV_CHANGE): wlan0: link becomes ready
[   13.559838] Bluetooth: Core ver 2.22
[   13.559940] NET: Registered PF_BLUETOOTH protocol family
[   13.559947] Bluetooth: HCI device and connection manager initialized
[   13.559963] Bluetooth: HCI socket layer initialized
[   13.559971] Bluetooth: L2CAP socket layer initialized
[   13.559985] Bluetooth: SCO socket layer initialized
[   13.567272] Bluetooth: HCI UART driver ver 2.3
[   13.567296] Bluetooth: HCI UART protocol H4 registered
[   13.567358] Bluetooth: HCI UART protocol Three-wire (H5) registered
[   13.567532] Bluetooth: HCI UART protocol Broadcom registered
[   13.896883] Bluetooth: BNEP (Ethernet Emulation) ver 1.3
[   13.896903] Bluetooth: BNEP filters: protocol multicast
[   13.896918] Bluetooth: BNEP socket layer initialized
[   13.908872] NET: Registered PF_ALG protocol family
[   31.711323] cam-dummy-reg: disabling

** sudo vcdbg log msg **
005434.505: arasan: arasan_emmc_open
005863.081: brfs: File read: /mfs/sd/config.txt
005864.153: brfs: File read: 2169 bytes
005982.323: HDMI1:EDID error reading EDID block 0 attempt 0
005988.347: HDMI1:EDID error reading EDID block 0 attempt 1
005994.372: HDMI1:EDID error reading EDID block 0 attempt 2
006000.394: HDMI1:EDID error reading EDID block 0 attempt 3
006006.419: HDMI1:EDID error reading EDID block 0 attempt 4
006012.442: HDMI1:EDID error reading EDID block 0 attempt 5
006018.466: HDMI1:EDID error reading EDID block 0 attempt 6
006024.488: HDMI1:EDID error reading EDID block 0 attempt 7
006030.512: HDMI1:EDID error reading EDID block 0 attempt 8
006036.535: HDMI1:EDID error reading EDID block 0 attempt 9
006037.550: HDMI1:EDID giving up on reading EDID block 0
006041.139: brfs: File read: /mfs/sd/config.txt
007149.270: gpioman: gpioman_get_pin_num: pin DISPLAY_DSI_PORT not defined
007151.787: *** Restart logging
007151.809: brfs: File read: 2169 bytes
007215.763: hdmi: HDMI1:EDID error reading EDID block 0 attempt 0
007221.788: hdmi: HDMI1:EDID error reading EDID block 0 attempt 1
007227.812: hdmi: HDMI1:EDID error reading EDID block 0 attempt 2
007233.838: hdmi: HDMI1:EDID error reading EDID block 0 attempt 3
007239.861: hdmi: HDMI1:EDID error reading EDID block 0 attempt 4
007245.888: hdmi: HDMI1:EDID error reading EDID block 0 attempt 5
007254.025: hdmi: HDMI1:EDID error reading EDID block 0 attempt 6
007260.067: hdmi: HDMI1:EDID error reading EDID block 0 attempt 7
007266.106: hdmi: HDMI1:EDID error reading EDID block 0 attempt 8
007272.148: hdmi: HDMI1:EDID error reading EDID block 0 attempt 9
007273.173: hdmi: HDMI1:EDID giving up on reading EDID block 0
007278.246: hdmi: HDMI1:EDID error reading EDID block 0 attempt 0
007284.287: hdmi: HDMI1:EDID error reading EDID block 0 attempt 1
007290.325: hdmi: HDMI1:EDID error reading EDID block 0 attempt 2
007296.365: hdmi: HDMI1:EDID error reading EDID block 0 attempt 3
007302.404: hdmi: HDMI1:EDID error reading EDID block 0 attempt 4
007308.445: hdmi: HDMI1:EDID error reading EDID block 0 attempt 5
007314.484: hdmi: HDMI1:EDID error reading EDID block 0 attempt 6
007320.525: hdmi: HDMI1:EDID error reading EDID block 0 attempt 7
007326.563: hdmi: HDMI1:EDID error reading EDID block 0 attempt 8
007332.604: hdmi: HDMI1:EDID error reading EDID block 0 attempt 9
007333.629: hdmi: HDMI1:EDID giving up on reading EDID block 0
007333.659: hdmi: HDMI:hdmi_get_state is deprecated, use hdmi_get_display_state instead
007333.683: HDMI0: hdmi_pixel_encoding: 300000000
007333.703: HDMI1: hdmi_pixel_encoding: 300000000
007339.064: dtb_file 'bcm2711-rpi-4-b.dtb'
007349.065: brfs: File read: /mfs/sd/bcm2711-rpi-4-b.dtb
007349.089: Loading 'bcm2711-rpi-4-b.dtb' to 0x100 size 0xc983
007373.804: brfs: File read: 51587 bytes
007388.749: brfs: File read: /mfs/sd/overlays/overlay_map.dtb
007515.586: Found camera 'ov5647'
007516.308: brfs: File read: 1783 bytes
007529.113: brfs: File read: /mfs/sd/overlays/ov5647.dtbo
007602.113: Loaded overlay 'ov5647'
007730.953: brfs: File read: 3367 bytes
007735.308: brfs: File read: /mfs/sd/config.txt
007735.891: dtparam: i2c_arm=on
007752.409: dtparam: i2s=on
007767.748: dtparam: spi=on
007783.325: dtparam: audio=on
007803.331: brfs: File read: 2169 bytes
007821.048: brfs: File read: /mfs/sd/overlays/vc4-fkms-v3d-pi4.dtbo
007854.477: Loaded overlay 'vc4-fkms-v3d'
007921.446: brfs: File read: 1446 bytes
007934.251: brfs: File read: /mfs/sd/overlays/ov5647.dtbo
008008.310: Loaded overlay 'ov5647'
008131.337: brfs: File read: 3367 bytes
008134.686: brfs: File read: /mfs/sd/cmdline.txt
008134.738: Read command line from file 'cmdline.txt':
008134.756: 'console=serial0,115200 console=tty1 root=PARTUUID=d3fa126c-02 rootfstype=ext4 fsck.repair=yes rootwait'
008396.903: brfs: File read: 103 bytes
009658.425: brfs: File read: /mfs/sd/kernel8.img
009658.455: Loading 'kernel8.img' to 0x80000 size 0x7c8a1d
011730.571: Kernel relocated to 0x200000
011730.589: Device tree loaded to 0x2eff2c00 (size 0xd320)
011752.221: gpioman: gpioman_get_pin_num: pin SDCARD_CONTROL_POWER not defined
013664.853: vchiq_core: vchiq_init_state: slot_zero = 0xdb000000, is_master = 1
013667.609: hdmi: HDMI:hdmi_get_state is deprecated, use hdmi_get_display_state instead
013673.677: TV service:host side not connected, dropping notification 0x00000002, 0x00000001, 0x0000005f
017358.671: camsubs: Ignoring camera 0 as unicam device not available
017709.523: TV service:host side not connected, dropping notification 0x00000008, 0x00000004, 0x00000000
527748.104: mmal: mmal_vll_load: could not load VLL 'videnc.vll':
540892.357: mmal: mmal_vll_load: could not load VLL 'videnc.vll':
700695.443: mmal: mmal_vll_load: could not load VLL 'videnc.vll':

** sudo vcdbg log assert **
No messages available

** sudo vcdbg log ex **
No exceptions found

--------------------------------------------------------------------------------
Memory
--------------------------------------------------------------------------------
** cat /proc/meminfo **
MemTotal:        1842652 kB
MemFree:         1562752 kB
MemAvailable:    1684552 kB
Buffers:           13640 kB
Cached:           148592 kB
SwapCached:            0 kB
Active:            64136 kB
Inactive:         125724 kB
Active(anon):        520 kB
Inactive(anon):    27868 kB
Active(file):      63616 kB
Inactive(file):    97856 kB
Unevictable:          16 kB
Mlocked:              16 kB
SwapTotal:        102396 kB
SwapFree:         102396 kB
Dirty:               232 kB
Writeback:             0 kB
AnonPages:         27568 kB
Mapped:            34500 kB
Shmem:               760 kB
KReclaimable:      18604 kB
Slab:              40676 kB
SReclaimable:      18604 kB
SUnreclaim:        22072 kB
KernelStack:        2196 kB
PageTables:         1420 kB
NFS_Unstable:          0 kB
Bounce:                0 kB
WritebackTmp:          0 kB
CommitLimit:     1023720 kB
Committed_AS:     139444 kB
VmallocTotal:   259653632 kB
VmallocUsed:        8924 kB
VmallocChunk:          0 kB
Percpu:              640 kB
CmaTotal:         327680 kB
CmaFree:          300244 kB

** sudo cat /sys/kernel/debug/dma_buf/bufinfo **

Dma-buf Objects:
size            flags           mode            count           exp_name        ino

Total 0 objects, 0 bytes

** sudo cat /sys/kernel/debug/vcsm-cma/state **

VC-ServiceHandle     000000002c49543f

Resources

Total resource count:   0

--------------------------------------------------------------------------------
Media Devices
--------------------------------------------------------------------------------
** media-ctl -d 0 -p **
Media controller API version 5.15.32

Media device information
------------------------
driver          bcm2835-isp
model           bcm2835-isp
serial
bus info        platform:bcm2835-isp
hw revision     0x0
driver version  5.15.32

Device topology
- entity 1: bcm2835_isp0 (4 pads, 4 links)
            type Node subtype Unknown flags 0
        pad0: Sink
                <- "bcm2835-isp0-output0":0 [ENABLED,IMMUTABLE]
        pad1: Source
                -> "bcm2835-isp0-capture1":0 [ENABLED,IMMUTABLE]
        pad2: Source
                -> "bcm2835-isp0-capture2":0 [ENABLED,IMMUTABLE]
        pad3: Source
                -> "bcm2835-isp0-capture3":0 [ENABLED,IMMUTABLE]

- entity 6: bcm2835-isp0-output0 (1 pad, 1 link)
            type Node subtype V4L flags 0
            device node name /dev/video13
        pad0: Source
                -> "bcm2835_isp0":0 [ENABLED,IMMUTABLE]

- entity 12: bcm2835-isp0-capture1 (1 pad, 1 link)
             type Node subtype V4L flags 0
             device node name /dev/video14
        pad0: Sink
                <- "bcm2835_isp0":1 [ENABLED,IMMUTABLE]

- entity 18: bcm2835-isp0-capture2 (1 pad, 1 link)
             type Node subtype V4L flags 0
             device node name /dev/video15
        pad0: Sink
                <- "bcm2835_isp0":2 [ENABLED,IMMUTABLE]

- entity 24: bcm2835-isp0-capture3 (1 pad, 1 link)
             type Node subtype V4L flags 0
             device node name /dev/video16
        pad0: Sink
                <- "bcm2835_isp0":3 [ENABLED,IMMUTABLE]

** media-ctl -d 1 -p **
Media controller API version 5.15.32

Media device information
------------------------
driver          bcm2835-codec
model           bcm2835-codec
serial          0000
bus info        platform:bcm2835-codec
hw revision     0x1
driver version  5.15.32

Device topology
- entity 1: bcm2835-codec-decode-source (1 pad, 1 link)
            type Node subtype V4L flags 0
            device node name /dev/video10
        pad0: Source
                -> "bcm2835-codec-decode-proc":0 [ENABLED,IMMUTABLE]

- entity 3: bcm2835-codec-decode-proc (2 pads, 2 links)
            type Node subtype Unknown flags 0
        pad0: Sink
                <- "bcm2835-codec-decode-source":0 [ENABLED,IMMUTABLE]
        pad1: Source
                -> "bcm2835-codec-decode-sink":0 [ENABLED,IMMUTABLE]

- entity 6: bcm2835-codec-decode-sink (1 pad, 1 link)
            type Node subtype V4L flags 0
            device node name /dev/video10
        pad0: Sink
                <- "bcm2835-codec-decode-proc":1 [ENABLED,IMMUTABLE]

- entity 15: bcm2835-codec-encode-source (1 pad, 1 link)
             type Node subtype V4L flags 0
             device node name /dev/video11
        pad0: Source
                -> "bcm2835-codec-encode-proc":0 [ENABLED,IMMUTABLE]

- entity 17: bcm2835-codec-encode-proc (2 pads, 2 links)
             type Node subtype Unknown flags 0
        pad0: Sink
                <- "bcm2835-codec-encode-source":0 [ENABLED,IMMUTABLE]
        pad1: Source
                -> "bcm2835-codec-encode-sink":0 [ENABLED,IMMUTABLE]

- entity 20: bcm2835-codec-encode-sink (1 pad, 1 link)
             type Node subtype V4L flags 0
             device node name /dev/video11
        pad0: Sink
                <- "bcm2835-codec-encode-proc":1 [ENABLED,IMMUTABLE]

- entity 29: bcm2835-codec-isp-source (1 pad, 1 link)
             type Node subtype V4L flags 0
             device node name /dev/video12
        pad0: Source
                -> "bcm2835-codec-isp-proc":0 [ENABLED,IMMUTABLE]

- entity 31: bcm2835-codec-isp-proc (2 pads, 2 links)
             type Node subtype Unknown flags 0
        pad0: Sink
                <- "bcm2835-codec-isp-source":0 [ENABLED,IMMUTABLE]
        pad1: Source
                -> "bcm2835-codec-isp-sink":0 [ENABLED,IMMUTABLE]

- entity 34: bcm2835-codec-isp-sink (1 pad, 1 link)
             type Node subtype V4L flags 0
             device node name /dev/video12
        pad0: Sink
                <- "bcm2835-codec-isp-proc":1 [ENABLED,IMMUTABLE]

- entity 43: bcm2835-codec-image_fx-source (1 pad, 1 link)
             type Node subtype V4L flags 0
             device node name /dev/video18
        pad0: Source
                -> "bcm2835-codec-image_fx-proc":0 [ENABLED,IMMUTABLE]

- entity 45: bcm2835-codec-image_fx-proc (2 pads, 2 links)
             type Node subtype Unknown flags 0
        pad0: Sink
                <- "bcm2835-codec-image_fx-source":0 [ENABLED,IMMUTABLE]
        pad1: Source
                -> "bcm2835-codec-image_fx-sink":0 [ENABLED,IMMUTABLE]

- entity 48: bcm2835-codec-image_fx-sink (1 pad, 1 link)
             type Node subtype V4L flags 0
             device node name /dev/video18
        pad0: Sink
                <- "bcm2835-codec-image_fx-proc":1 [ENABLED,IMMUTABLE]

- entity 57: bcm2835-codec-encode_image-sour (1 pad, 1 link)
             type Node subtype V4L flags 0
             device node name /dev/video31
        pad0: Source
                -> "bcm2835-codec-encode_image-proc":0 [ENABLED,IMMUTABLE]

- entity 59: bcm2835-codec-encode_image-proc (2 pads, 2 links)
             type Node subtype Unknown flags 0
        pad0: Sink
                <- "bcm2835-codec-encode_image-sour":0 [ENABLED,IMMUTABLE]
        pad1: Source
                -> "bcm2835-codec-encode_image-sink":0 [ENABLED,IMMUTABLE]

- entity 62: bcm2835-codec-encode_image-sink (1 pad, 1 link)
             type Node subtype V4L flags 0
             device node name /dev/video31
        pad0: Sink
                <- "bcm2835-codec-encode_image-proc":1 [ENABLED,IMMUTABLE]

** media-ctl -d 2 -p **
Media controller API version 5.15.32

Media device information
------------------------
driver          bcm2835-isp
model           bcm2835-isp
serial
bus info        platform:bcm2835-isp
hw revision     0x0
driver version  5.15.32

Device topology
- entity 1: bcm2835_isp0 (4 pads, 4 links)
            type Node subtype Unknown flags 0
        pad0: Sink
                <- "bcm2835-isp0-output0":0 [ENABLED,IMMUTABLE]
        pad1: Source
                -> "bcm2835-isp0-capture1":0 [ENABLED,IMMUTABLE]
        pad2: Source
                -> "bcm2835-isp0-capture2":0 [ENABLED,IMMUTABLE]
        pad3: Source
                -> "bcm2835-isp0-capture3":0 [ENABLED,IMMUTABLE]

- entity 6: bcm2835-isp0-output0 (1 pad, 1 link)
            type Node subtype V4L flags 0
            device node name /dev/video20
        pad0: Source
                -> "bcm2835_isp0":0 [ENABLED,IMMUTABLE]

- entity 12: bcm2835-isp0-capture1 (1 pad, 1 link)
             type Node subtype V4L flags 0
             device node name /dev/video21
        pad0: Sink
                <- "bcm2835_isp0":1 [ENABLED,IMMUTABLE]

- entity 18: bcm2835-isp0-capture2 (1 pad, 1 link)
             type Node subtype V4L flags 0
             device node name /dev/video22
        pad0: Sink
                <- "bcm2835_isp0":2 [ENABLED,IMMUTABLE]

- entity 24: bcm2835-isp0-capture3 (1 pad, 1 link)
             type Node subtype V4L flags 0
             device node name /dev/video23
        pad0: Sink
                <- "bcm2835_isp0":3 [ENABLED,IMMUTABLE]

** media-ctl -d 3 -p **
Media controller API version 5.15.32

Media device information
------------------------
driver          unicam
model           unicam
serial
bus info        platform:fe801000.csi
hw revision     0x0
driver version  5.15.32

Device topology
- entity 1: ov5647 10-0036 (1 pad, 1 link)
            type V4L2 subdev subtype Sensor flags 0
            device node name /dev/v4l-subdev0
        pad0: Source
                [fmt:SGBRG10_1X10/640x480 field:none colorspace:raw
                 crop.bounds:(16,6)/2592x1944
                 crop:(32,6)/2560x1920]
                -> "unicam-image":0 [ENABLED,IMMUTABLE]

- entity 3: unicam-image (1 pad, 1 link)
            type Node subtype V4L flags 1
            device node name /dev/video0
        pad0: Sink
                <- "ov5647 10-0036":0 [ENABLED,IMMUTABLE]

** media-ctl -d 4 -p **
Failed to enumerate /dev/media4 (-2)

--------------------------------------------------------------------------------
Cameras
--------------------------------------------------------------------------------
** libcamera-vid --list-cameras **
[0:21:42.073389730] [1026]  INFO Camera camera_manager.cpp:293 libcamera v0.0.0+3424-e68e0f1e
[0:21:42.090667184] [1027] ERROR CameraSensor camera_sensor.cpp:551 'ov5647 10-0036': Camera sensor does not support test pattern modes.
[0:21:42.109005087] [1027]  INFO RPI raspberrypi.cpp:1317 Registered camera /base/soc/i2c0mux/i2c@1/ov5647@36 to Unicam device /dev/media3 and ISP device /dev/media0
Available cameras
-----------------
0 : ov5647 [2592x1944] (/base/soc/i2c0mux/i2c@1/ov5647@36)
    Modes: 'SGBRG10_CSI2P' : 640x480 1296x972 1920x1080 2592x1944

--------------------------------------------------------------------------------
Versions
--------------------------------------------------------------------------------
** uname -a **
Linux raspberrypi 5.15.32-v8+ #1538 SMP PREEMPT Thu Mar 31 19:40:39 BST 2022 aarch64 GNU/Linux

** cat /etc/os-release **
PRETTY_NAME="Debian GNU/Linux 11 (bullseye)"
NAME="Debian GNU/Linux"
VERSION_ID="11"
VERSION="11 (bullseye)"
VERSION_CODENAME=bullseye
ID=debian
HOME_URL="https://www.debian.org/"
SUPPORT_URL="https://www.debian.org/support"
BUG_REPORT_URL="https://bugs.debian.org/"

** vcgencmd version **
Mar 24 2022 13:20:19
Copyright (c) 2012 Broadcom
version e5a963efa66a1974127860b42e913d2374139ff5 (clean) (release) (start_x)

** libcamera-vid --version **
libcamera-apps build: 0dc5ea038c79 04-03-2022 (10:35:06)
libcamera build: v0.0.0+3424-e68e0f1e

--------------------------------------------------------------------------------
libcamera-vid -t 0 --width 640 --height 480 -q 100 -n  --inline --codec mjpeg --listen -o tcp://0.0.0.0:8888 -v
--------------------------------------------------------------------------------
Options:
    verbose: 1
    info_text:#%frame (%fps fps) exp %exp ag %ag dg %dg
    timeout: 0
    width: 640
    height: 480
    output: tcp://0.0.0.0:8888
    post_process_file:
    rawfull: 0
    preview: none
    qt-preview: 0
    transform: identity
    roi: all
    metering: centre
    exposure: normal
    ev: 0
    awb: auto
    flush: false
    wrap: 0
    brightness: 0
    contrast: 1
    saturation: 1
    sharpness: 1
    framerate: 30
    denoise: auto
    viewfinder-width: 0
    viewfinder-height: 0
    tuning-file: (libcamera)
    lores-width: 0
    lores-height: 0
    mode: unspecified
    viewfinder-mode: unspecified
    bitrate: 0
    profile:
    level:
    intra: 0
    inline: 1
    save-pts:
    codec: mjpeg
    quality (for MJPEG): 100
    keypress: 0
    signal: 0
    initial: record
    split: 0
    segment: 0
    circular: 0
Waiting for client to connect...
Client connection accepted
Running without preview window
Opening camera...
[0:21:41.220868266] [975]  INFO Camera camera_manager.cpp:293 libcamera v0.0.0+3424-e68e0f1e
[0:21:41.239473463] [976] ERROR CameraSensor camera_sensor.cpp:551 'ov5647 10-0036': Camera sensor does not support test pattern modes.
[0:21:41.258490691] [976]  INFO RPI raspberrypi.cpp:1317 Registered camera /base/soc/i2c0mux/i2c@1/ov5647@36 to Unicam device /dev/media3 and ISP device /dev/media0
Acquired camera /base/soc/i2c0mux/i2c@1/ov5647@36
Configuring video...
[0:21:41.259337495] [975]  INFO Camera camera.cpp:1028 configuring streams: (0) 640x480-YUV420
[0:21:41.259806508] [976]  INFO RPI raspberrypi.cpp:747 Sensor: /base/soc/i2c0mux/i2c@1/ov5647@36 - Selected sensor format: 640x480-SGBRG10_1X10 - Selected unicam format: 640x480-pGAA
Camera streams configured
Buffers allocated and mapped
Video setup complete
Opened MjpegEncoder
Requests created
[0:21:41.269879161] [985]  INFO IPARPI raspberrypi.cpp:631 Request ctrl: Saturation = 1.000000
[0:21:41.269959327] [985]  INFO IPARPI raspberrypi.cpp:631 Request ctrl: Contrast = 1.000000
[0:21:41.269980864] [985]  INFO IPARPI raspberrypi.cpp:631 Request ctrl: Brightness = 0.000000
[0:21:41.270000678] [985]  INFO IPARPI raspberrypi.cpp:631 Request ctrl: AwbMode = 0
[0:21:41.270022363] [985]  INFO IPARPI raspberrypi.cpp:631 Request ctrl: Sharpness = 1.000000
[0:21:41.270042141] [985]  INFO IPARPI raspberrypi.cpp:631 Request ctrl: ExposureValue = 0.000000
[0:21:41.270080918] [985]  INFO IPARPI raspberrypi.cpp:631 Request ctrl: AeExposureMode = 0
[0:21:41.270099288] [985]  INFO IPARPI raspberrypi.cpp:631 Request ctrl: FrameDurationLimits = [ 33333, 33333 ]
[0:21:41.270123140] [985]  INFO IPARPI raspberrypi.cpp:631 Request ctrl: AeMeteringMode = 0
[0:21:41.270140250] [985]  INFO IPARPI raspberrypi.cpp:631 Request ctrl: NoiseReductionMode = 1
Camera started!
Viewfinder frame 0
NetOutput: output buffer 0x7fb43b8010 size 166544
Viewfinder frame 1
Viewfinder frame 2
Viewfinder frame 3
NetOutput: output buffer 0x7fb4377010 size 163576
NetOutput: output buffer 0x7fb4336010 size 166918
NetOutput: output buffer 0x7f98044af0 size 154363
Viewfinder frame 4
Viewfinder frame 5
NetOutput: output buffer 0x7fa00454f0 size 154583

pamacs@raspberrypi:~ $
naushir commented 2 years ago

Can you try setting up a streaming session with libav? You can find instructions on how to do that here.

routingalchemy commented 2 years ago

Ugh, that was easier than I thought. Thank you.