自己设计的载板，将max96712 连接到cis a port 4 lanes 接受数据csi报告超时

Robotics & Edge Computing Jetson & Embedded Systems Jetson Xavier NX
,
1

tegra_channel_open: vi-output, ar0234 2-0033
v4l2-ctl-4801 [005] … 3363.244197: tegra_channel_set_power: ar0234 2-0033 : 0x1
v4l2-ctl-4801 [005] … 3363.244300: camera_common_s_power: status : 0x1
v4l2-ctl-4801 [005] … 3363.244321: tegra_channel_set_power: 13e00000.host1x:nvcsi@15a00000- : 0x1
v4l2-ctl-4801 [005] … 3363.244323: csi_s_power: enable : 0x1
v4l2-ctl-4801 [005] … 3363.245841: tegra_channel_capture_setup: vnc_id 0 W 1920 H 1300 fmt 10
vi-output, ar02-4802 [005] … 3363.255082: vi_task_submit: class_id:48 ch:0 syncpt_id:36 syncpt_thresh:0 pid:4802 tid:4802
vi-output, ar02-4802 [005] … 3363.255088: vi_task_submit: class_id:48 ch:0 syncpt_id:36 syncpt_thresh:0 pid:4802 tid:4802
vi-output, ar02-4802 [005] … 3363.255090: vi_task_submit: class_id:48 ch:0 syncpt_id:36 syncpt_thresh:0 pid:4802 tid:4802
vi-output, ar02-4802 [005] … 3363.255091: vi_task_submit: class_id:48 ch:0 syncpt_id:36 syncpt_thresh:0 pid:4802 tid:4802
v4l2-ctl-4801 [006] … 3363.255113: tegra_channel_set_stream: enable : 0x1
v4l2-ctl-4801 [005] … 3363.257472: tegra_channel_set_stream: 13e00000.host1x:nvcsi@15a00000- : 0x1
v4l2-ctl-4801 [005] … 3363.257475: csi_s_stream: enable : 0x1
v4l2-ctl-4801 [005] … 3363.258056: tegra_channel_set_stream: ar0234 2-0033 : 0x1
kworker/3:1-60 [003] … 3363.280090: rtcpu_string: tstamp:105778672525 id:0x04010000 str:“VM0 activating.”
kworker/3:1-60 [003] … 3363.280091: rtcpu_string: tstamp:105778748561 id:0x04010000 str:"calibration status1 1929be52 status2 2d295613
"
kworker/3:1-60 [003] … 3363.280096: rtcpu_string: tstamp:105778749191 id:0x04010000 str:"calibration status1 2afa4a12 status2 2109d6b5
"
kworker/3:1-60 [003] … 3363.280097: rtcpu_string: tstamp:105778749820 id:0x04010000 str:"calibration status1 2b29d255 status2 25074f0f
"
kworker/3:1-60 [003] … 3363.280099: rtcpu_string: tstamp:105778750445 id:0x04010000 str:"calibration status1 2738cab4 status2 28e93e90
"
kworker/3:1-60 [003] … 3363.280100: rtcpu_string: tstamp:105778760480 id:0x04010000 str:“NVCSILP clock rate = 408000000 Hz.
"
kworker/3:1-60 [003] … 3363.280102: rtcpu_string: tstamp:105778925812 id:0x04010000 str:“tegra_nvcsi_stream_set_config(vm0, stream=0, csi”
kworker/3:1-60 [003] … 3363.280102: rtcpu_string: tstamp:105778925917 id:0x04010000 str:”=0)
"
kworker/3:1-60 [003] … 3363.280103: rtcpu_string: tstamp:105778926291 id:0x04010000 str:“MIPI clock = 1000000 kHz, tHS-SETTLE = 0, tCLK-S”
kworker/3:1-60 [003] … 3363.280104: rtcpu_string: tstamp:105778926396 id:0x04010000 str:“ETTLE = 0
"
kworker/3:1-60 [003] … 3363.280104: rtcpu_string: tstamp:105778926606 id:0x04010000 str:”===== NVCSI Stream Configuration =====
"
kworker/3:1-60 [003] … 3363.280105: rtcpu_string: tstamp:105778926852 id:0x04010000 str:"stream_id: PP 0, csi_port: PORT A
"
kworker/3:1-60 [003] … 3363.280106: rtcpu_string: tstamp:105778927089 id:0x04010000 str:"Brick: PHY 0, Mode: D-PHY
"
kworker/3:1-60 [003] … 3363.280107: rtcpu_string: tstamp:105778927377 id:0x04010000 str:"Partition: CIL A, LP bypass: Enabled, Lanes: 4
"
kworker/3:1-60 [003] … 3363.280108: rtcpu_string: tstamp:105778927560 id:0x04010000 str:"Clock information:
"
kworker/3:1-60 [003] … 3363.280109: rtcpu_string: tstamp:105778927866 id:0x04010000 str:"MIPI clock rate: 1000.00 MHz
"
kworker/3:1-60 [003] … 3363.280110: rtcpu_string: tstamp:105778928111 id:0x04010000 str:“T_HS settle: 0, T_CLK settle: 0
"
kworker/3:1-60 [003] … 3363.280111: rtcpu_string: tstamp:105778928338 id:0x04010000 str:”======================================
"
kworker/3:1-60 [003] … 3363.280111: rtcpu_string: tstamp:105778930274 id:0x04010000 str:"tegra_nvcsi_stream_open(vm0, stream=0, csi=0)
"
kworker/3:1-60 [003] … 3363.280112: rtcpu_string: tstamp:105778930886 id:0x04010000 str:“nvcsi_reset_data_lanes: NVCSI_PHY_0_NVCSI_CIL_A_”
kworker/3:1-60 [003] … 3363.280113: rtcpu_string: tstamp:105778930990 id:0x04010000 str:"SW_RESET_0 = 00000003
"
kworker/3:1-60 [003] … 3363.280114: rtcpu_string: tstamp:105778931353 id:0x04010000 str:“nvcsi_reset_data_lanes: NVCSI_PHY_0_NVCSI_CIL_B_”
kworker/3:1-60 [003] … 3363.280114: rtcpu_string: tstamp:105778931459 id:0x04010000 str:"SW_RESET_0 = 00000003
"
kworker/3:1-60 [003] … 3363.280115: rtcpu_string: tstamp:105778932139 id:0x04010000 str:“nvcsi_reset_lane_merger: NVCSI_PHY_0_LM_SW_RESET”
kworker/3:1-60 [003] … 3363.280116: rtcpu_string: tstamp:105778932245 id:0x04010000 str:“0 = 00000001
"
kworker/3:1-60 [003] … 3363.280117: rtcpu_string: tstamp:105778938259 id:0x04010000 str:“nvcsi_reset_lane_merger: NVCSI_PHY_0_LM_SW_RESET”
kworker/3:1-60 [003] … 3363.280117: rtcpu_string: tstamp:105778938364 id:0x04010000 str:“0 = 00000000
"
kworker/3:1-60 [003] … 3363.280118: rtcpu_string: tstamp:105778938944 id:0x04010000 str:"nvcsi_calc_ths_settle ths_settle 50
"
kworker/3:1-60 [003] … 3363.280119: rtcpu_string: tstamp:105778939213 id:0x04010000 str:"nvcsi_calc_ths_settle ths_settle 50
"
kworker/3:1-60 [003] … 3363.280120: rtcpu_string: tstamp:105778939480 id:0x04010000 str:"nvcsi_calc_ths_settle ths_settle 50
"
kworker/3:1-60 [003] … 3363.280120: rtcpu_string: tstamp:105778939737 id:0x04010000 str:"nvcsi_calc_tclk_settle tclk_settle 75
"
kworker/3:1-60 [003] … 3363.280121: rtcpu_string: tstamp:105778940188 id:0x04010000 str:"nvcsi_reset_data_lanes: NVCSI_PHY_0_NVCSI_CIL_A”
kworker/3:1-60 [003] … 3363.280122: rtcpu_string: tstamp:105778940292 id:0x04010000 str:"SW_RESET_0 = 00000000
"
kworker/3:1-60 [003] … 3363.280122: rtcpu_string: tstamp:105778940650 id:0x04010000 str:"nvcsi_reset_data_lanes: NVCSI_PHY_0_NVCSI_CIL_B”
kworker/3:1-60 [003] … 3363.280123: rtcpu_string: tstamp:105778940752 id:0x04010000 str:"SW_RESET_0 = 00000000
"
kworker/3:1-60 [003] … 3363.280124: rtcpu_string: tstamp:105778941196 id:0x04010000 str:"Deskew setup message sent for port 0 num_lane 4
"
kworker/3:1-60 [003] … 3363.280126: rtcpu_vinotify_event: tstamp:105779393403 cch:0 vi:0 tag:VIFALC_TDSTATE channel:0x23 frame:0 vi_tstamp:3384923410912 data:0x799d580010000000
kworker/3:1-60 [003] … 3363.280127: rtcpu_vinotify_event: tstamp:105779393540 cch:0 vi:0 tag:VIFALC_TDSTATE channel:0x23 frame:0 vi_tstamp:3384923453024 data:0x0000000031000001
kworker/3:1-60 [003] … 3363.280127: rtcpu_vinotify_event: tstamp:105779393695 cch:0 vi:0 tag:VIFALC_TDSTATE channel:0x23 frame:0 vi_tstamp:3384923471136 data:0x799d550010000000
kworker/3:1-60 [003] … 3363.280127: rtcpu_vinotify_event: tstamp:105779393828 cch:0 vi:0 tag:VIFALC_ACTIONLST channel:0x23 frame:0 vi_tstamp:3384923491488 data:0x0000000007020001
kworker/3:1-60 [003] … 3363.280127: rtcpu_vinotify_event: tstamp:105779393981 cch:0 vi:0 tag:VIFALC_TDSTATE channel:0x23 frame:0 vi_tstamp:3384923533856 data:0x0000000031000002
vi-output, ar02-4803 [000] … 3365.860968: tegra_channel_capture_setup: vnc_id 0 W 1920 H 1300 fmt 10
vi-output, ar02-4802 [006] … 3365.861119: vi_task_submit: class_id:48 ch:0 syncpt_id:36 syncpt_thresh:0 pid:4802 tid:4802
vi-output, ar02-4802 [006] … 3365.861136: vi_task_submit: class_id:48 ch:0 syncpt_id:36 syncpt_thresh:0 pid:4802 tid:4802
vi-output, ar02-4802 [006] … 3365.861139: vi_task_submit: class_id:48 ch:0 syncpt_id:36 syncpt_thresh:0 pid:4802 tid:4802
vi-output, ar02-4802 [006] … 3365.861141: vi_task_submit: class_id:48 ch:0 syncpt_id:36 syncpt_thresh:0 pid:4802 tid:4802
kworker/3:1-60 [003] … 3365.912139: rtcpu_vinotify_event: tstamp:105860774828 cch:0 vi:0 tag:VIFALC_TDSTATE channel:0x23 frame:0 vi_tstamp:3387529454048 data:0x799d580010000000
kworker/3:1-60 [003] … 3365.912140: rtcpu_vinotify_event: tstamp:105860774984 cch:0 vi:0 tag:VIFALC_TDSTATE channel:0x23 frame:0 vi_tstamp:3387529496128 data:0x0000000031000001
kworker/3:1-60 [003] … 3365.912141: rtcpu_vinotify_event: tstamp:105860775120 cch:0 vi:0 tag:VIFALC_TDSTATE channel:0x23 frame:0 vi_tstamp:3387529514272 data:0x799d550010000000
kworker/3:1-60 [003] … 3365.912141: rtcpu_vinotify_event: tstamp:105860775271 cch:0 vi:0 tag:VIFALC_ACTIONLST channel:0x23 frame:0 vi_tstamp:3387529534560 data:0x0000000007020001
kworker/3:1-60 [003] … 3365.912142: rtcpu_vinotify_event: tstamp:105860775405 cch:0 vi:0 tag:VIFALC_TDSTATE channel:0x23 frame:0 vi_tstamp:3387529576960 data:0x0000000031000002
vi-output, ar02-4803 [001] … 3368.421131: tegra_channel_capture_setup: vnc_id 0 W 1920 H 1300 fmt 10
vi-output, ar02-4802 [006] … 3368.421258: vi_task_submit: class_id:48 ch:0 syncpt_id:36 syncpt_thresh:0 pid:4802 tid:4802
vi-output, ar02-4802 [006] … 3368.421274: vi_task_submit: class_id:48 ch:0 syncpt_id:36 syncpt_thresh:0 pid:4802 tid:4802
vi-output, ar02-4802 [006] … 3368.421276: vi_task_submit: class_id:48 ch:0 syncpt_id:36 syncpt_thresh:0 pid:4802 tid:4802
vi-output, ar02-4802 [006] … 3368.421278: vi_task_submit: class_id:48 ch:0 syncpt_id:36 syncpt_thresh:0 pid:4802 tid:4802
kworker/3:1-60 [003] … 3368.436171: rtcpu_vinotify_event: tstamp:105940527596 cch:0 vi:0 tag:VIFALC_TDSTATE channel:0x23 frame:0 vi_tstamp:3390089586560 data:0x799d580010000000
kworker/3:1-60 [003] … 3368.436174: rtcpu_vinotify_event: tstamp:105940527735 cch:0 vi:0 tag:VIFALC_TDSTATE channel:0x23 frame:0 vi_tstamp:3390089628608 data:0x0000000031000001
kworker/3:1-60 [003] … 3368.436174: rtcpu_vinotify_event: tstamp:105940527889 cch:0 vi:0 tag:VIFALC_TDSTATE channel:0x23 frame:0 vi_tstamp:3390089646752 data:0x799d550010000000
kworker/3:1-60 [003] … 3368.436174: rtcpu_vinotify_event: tstamp:105940528023 cch:0 vi:0 tag:VIFALC_ACTIONLST channel:0x23 frame:0 vi_tstamp:3390089667072 data:0x0000000007020001
kworker/3:1-60 [003] … 3368.436174: rtcpu_vinotify_event: tstamp:105940528176 cch:0 vi:0 tag:VIFALC_TDSTATE channel:0x23 frame:0 vi_tstamp:3390089709440 data:0x0000000031000002
vi-output, ar02-4803 [001] … 3370.981091: tegra_channel_capture_setup: vnc_id 0 W 1920 H 1300 fmt 10
vi-output, ar02-4802 [006] … 3370.981317: vi_task_submit: class_id:48 ch:0 syncpt_id:36 syncpt_thresh:0 pid:4802 tid:4802
vi-output, ar02-4802 [006] … 3370.981336: vi_task_submit: class_id:48 ch:0 syncpt_id:36 syncpt_thresh:0 pid:4802 tid:4802
vi-output, ar02-4802 [006] … 3370.981339: vi_task_submit: class_id:48 ch:0 syncpt_id:36 syncpt_thresh:0 pid:4802 tid:4802
vi-output, ar02-4802 [006] … 3370.981341: vi_task_submit: class_id:48 ch:0 syncpt_id:36 syncpt_thresh:0 pid:4802 tid:4802
kworker/3:1-60 [003] … 3371.012208: rtcpu_vinotify_event: tstamp:106020304956 cch:0 vi:0 tag:VIFALC_TDSTATE channel:0x23 frame:0 vi_tstamp:3392649663648 data:0x799d580010000000
kworker/3:1-60 [003] … 3371.012210: rtcpu_vinotify_event: tstamp:106020823457 cch:0 vi:0 tag:VIFALC_TDSTATE channel:0x23 frame:0 vi_tstamp:3392649823936 data:0x0000000031000001
kworker/3:1-60 [003] … 3371.012210: rtcpu_vinotify_event: tstamp:106020823593 cch:0 vi:0 tag:VIFALC_TDSTATE channel:0x23 frame:0 vi_tstamp:3392649842112 data:0x799d550010000000
kworker/3:1-60 [003] … 3371.012210: rtcpu_vinotify_event: tstamp:106020823746 cch:0 vi:0 tag:VIFALC_ACTIONLST channel:0x23 frame:0 vi_tstamp:3392649862400 data:0x0000000007020001
kworker/3:1-60 [003] … 3371.012211: rtcpu_vinotify_event: tstamp:106020823880 cch:0 vi:0 tag:VIFALC_TDSTATE channel:0x23 frame:0 vi_tstamp:3392649905056 data:0x0000000031000002
v4l2-ctl-4801 [006] … 3371.959467: tegra_channel_close: vi-output, ar0234 2-0033
vi-output, ar02-4803 [001] … 3373.509430: tegra_channel_capture_setup: vnc_id 0 W 1920 H 1300 fmt 10
v4l2-ctl-4801 [006] … 3373.509868: tegra_channel_set_stream: enable : 0x0
v4l2-ctl-4801 [006] … 3373.509872: tegra_channel_set_stream: ar0234 2-0033 : 0x0
v4l2-ctl-4801 [006] … 3373.616410: tegra_channel_set_stream: 13e00000.host1x:nvcsi@15a00000- : 0x0
v4l2-ctl-4801 [006] … 3373.616414: csi_s_stream: enable : 0x0
v4l2-ctl-4801 [006] … 3373.623219: tegra_channel_set_power: ar0234 2-0033 : 0x0
v4l2-ctl-4801 [006] … 3373.623231: camera_common_s_power: status : 0x0
v4l2-ctl-4801 [006] … 3373.623269: tegra_channel_set_power: 13e00000.host1x:nvcsi@15a00000- : 0x0
v4l2-ctl-4801 [006] … 3373.623272: csi_s_power: enable : 0x0
kworker/3:1-60 [003] … 3379.927844: rtcpu_string: tstamp:106298226953 id:0x04010000 str:“VM0 deactivating.”

3

hello 827788213,

may I know which Jetpack release version you’re working with?
and.. according to the logs, it seems you’ve debug rce-fw applied, right? did you updating the binary with same L4T release version?

anyways,
you may give it another try to boost all the VI/CSI/ISP clocks.
please follow below for the commands.

sudo su
echo 1 > /sys/kernel/debug/bpmp/debug/clk/vi/mrq_rate_locked
echo 1 > /sys/kernel/debug/bpmp/debug/clk/isp/mrq_rate_locked
echo 1 > /sys/kernel/debug/bpmp/debug/clk/nvcsi/mrq_rate_locked
echo 1 > /sys/kernel/debug/bpmp/debug/clk/emc/mrq_rate_locked
cat /sys/kernel/debug/bpmp/debug/clk/vi/max_rate |tee /sys/kernel/debug/bpmp/debug/clk/vi/rate
cat /sys/kernel/debug/bpmp/debug/clk/isp/max_rate | tee /sys/kernel/debug/bpmp/debug/clk/isp/rate
cat /sys/kernel/debug/bpmp/debug/clk/nvcsi/max_rate | tee /sys/kernel/debug/bpmp/debug/clk/nvcsi/rate
cat /sys/kernel/debug/bpmp/debug/clk/emc/max_rate | tee /sys/kernel/debug/bpmp/debug/clk/emc/rate
4

root@tegra-ubuntu:/home/jetson# cat /etc/nv_tegra_release

R36 (release), REVISION: 4.0, GCID: 37537400, BOARD: generic, EABI: aarch64, DATE: Fri Sep 13 04:36:44 UTC 2024

KERNEL_VARIANT: oot

TARGET_USERSPACE_LIB_DIR=nvidia
TARGET_USERSPACE_LIB_DIR_PATH=usr/lib/aarch64-linux-gnu/nvidia
你好，我尝试过提高时钟，一样的结果，我也替换了bootloader 下的debug 版本的rce-fw。我发现收到的数据日志视乎包含sof eof但是没有正常的dt yuv格式的图像数据

5

hello 827788213,

did you meant you saw lots pairs of CHANSEL_PXL_SOF and CHANSEL_PXL_EOF from the VI tracing logs?

6

这个 CHANSEL_PXL_SOF没有出现，我截图有时候是黑色有时候是绿色。对于视频输入vi 的报错有详细分析的参考吗？或者您帮我看下我这个错误是是什么

捕获
捕获1746×155 62.3 KB

7

hello 827788213,

there did report CHANSEL_PXL_SOF/CHANSEL_PXL_EOF. your VI tracing logs has a frame detected by VI engine.
afterwards, it’s ATOMP_FRAME_DONE to indicate it’s complete writing a frame to memory.

are you able to use v4l IOCTL to fetch the frames? please see-also Applications Using V4L2 IOCTL Directly.
may I also know what’s the logs reported by kernel side? i.e. $ dmesg > klogs.txt

8

klogs.txt (87.8 KB)

捕获
捕获1563×259 51.7 KB

你好：附件为日志

9

hello 827788213,

it looks you’re able to fetch camera frames, each < indicate a success capture frame.
however, YUYV format types is referred as YUY2. please give it a try with below test pipeline to preview the stream,
$ gst-launch-1.0 v4l2src device=/dev/video0 ! video/x-raw,width=1920,height=1300,format=YUY2,framerate=30/1 ! xvimagesink

10

你好我尝试了是有图像数据的，但是为啥会一直报告timeout 2500ms

11

hello 827788213,

did you enable debug prints?
for instance, $public_sources/kernel_src/kernel/nvidia/drivers/media/platform/tegra/camera/fusa-capture/capture-vi.c

int vi_capture_status(...)
{
...
        dev_dbg(chan->dev, "%s: waiting for status, timeout:%d ms\n",
                __func__, timeout_ms);
12

是的，我看错了我以为是 dev_err(vi->dev,
“uncorr_err: request timed out after %d ms\n”,
timeout_ms);
这个报错，谢谢我的问题解决了