[28.889439] Initializing watchdogs [28.889493] /dev/watchdog0 [28.893936] [001/137] (960s left) gem_pipe_control_store_loop (fresh-buffer) [28.950639] Starting subtest: fresh-buffer [31.112275] Subtest fresh-buffer: SUCCESS (2.153s) [31.176159] [002/137] (958s left) sysfs_preempt_timeout (idempotent) [31.231219] Starting subtest: idempotent [31.231993] Starting dynamic subtest: vecs0 [31.232809] Dynamic subtest vecs0: SUCCESS (0.000s) [31.235945] Starting dynamic subtest: vcs0 [31.236693] Dynamic subtest vcs0: SUCCESS (0.000s) [31.239583] Starting dynamic subtest: bcs0 [31.240349] Dynamic subtest bcs0: SUCCESS (0.000s) [31.243437] Starting dynamic subtest: rcs0 [31.244279] Dynamic subtest rcs0: SUCCESS (0.000s) [31.247085] Starting dynamic subtest: vcs1 [31.247844] Dynamic subtest vcs1: SUCCESS (0.000s) [31.248633] Subtest idempotent: SUCCESS (0.002s) [31.268740] [003/137] (958s left) kms_ccs (pipe-d-bad-pixel-format-y_tiled_ccs) [31.621799] Starting subtest: pipe-D-bad-pixel-format-y_tiled_ccs [31.623873] Subtest pipe-D-bad-pixel-format-y_tiled_ccs: SKIP (0.000s) [31.768614] [004/137] (957s left) kms_vblank (pipe-a-wait-forked-busy) [31.858707] Starting subtest: pipe-A-wait-forked-busy [33.107805] Subtest pipe-A-wait-forked-busy: SUCCESS (1.250s) [33.216023] [005/137] (956s left) gem_workarounds (suspend-resume) [33.270511] Starting subtest: suspend-resume [49.622804] Subtest suspend-resume: SUCCESS (1.321s) [55.701476] [006/137] (954s left) kms_atomic (plane-primary-legacy) [55.908733] Starting subtest: plane-primary-legacy [56.010231] Subtest plane-primary-legacy: SUCCESS (0.101s) [56.161129] [007/137] (954s left) vc4/vc4_perfmon (destroy-invalid-perfmon) [56.241832] Subtest destroy-invalid-perfmon: SKIP (0.000s) [56.269621] [008/137] (954s left) sw_sync (alloc_timeline) [56.316628] Starting subtest: alloc_timeline [56.317449] Subtest alloc_timeline: SUCCESS (0.000s) [56.346345] [009/137] (954s left) perf_pmu (init-wait) [56.397089] Starting subtest: init-wait [56.397951] Starting dynamic subtest: rcs0 [56.398752] Dynamic subtest rcs0: SUCCESS (0.001s) [56.403405] Starting dynamic subtest: bcs0 [56.404176] Dynamic subtest bcs0: SUCCESS (0.000s) [56.408078] Starting dynamic subtest: vcs0 [56.408856] Dynamic subtest vcs0: SUCCESS (0.000s) [56.412922] Starting dynamic subtest: vcs1 [56.413714] Dynamic subtest vcs1: SUCCESS (0.000s) [56.417981] Starting dynamic subtest: vecs0 [56.418752] Dynamic subtest vecs0: SUCCESS (0.000s) [56.419684] Subtest init-wait: SUCCESS (0.002s) [56.435610] [010/137] (954s left) kms_cursor_legacy (cursor-vs-flip-legacy) [56.529556] Starting subtest: cursor-vs-flip-legacy [84.128012] Subtest cursor-vs-flip-legacy: SUCCESS (27.599s) [84.221972] [011/137] (926s left) gem_exec_reloc (basic-write-wc) [84.269513] Starting subtest: basic-write-wc [84.273231] Subtest basic-write-wc: SUCCESS (0.004s) [84.353678] [012/137] (926s left) gem_basic (multigpu-create-close) [84.397060] Starting subtest: multigpu-create-close [84.398562] Subtest multigpu-create-close: SKIP (0.000s) [84.428505] [013/137] (926s left) v3d/v3d_submit_csd (bad-flag) [84.484269] Subtest bad-flag: SKIP (0.000s) [84.511899] [014/137] (926s left) gem_exec_balancer (bonded-true-hang) [84.751980] Starting subtest: bonded-true-hang [99.131288] Subtest bonded-true-hang: SUCCESS (14.379s) [99.163239] [015/137] (911s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-blt) [99.256229] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-blt [99.257654] Subtest psr-2p-scndscrn-spr-indfb-draw-blt: SKIP (0.000s) [99.314456] [016/137] (911s left) api_intel_bb (blit-noreloc-keep-cache) [99.355396] Starting subtest: blit-noreloc-keep-cache [99.360688] Subtest blit-noreloc-keep-cache: SUCCESS (0.005s) [99.427703] [017/137] (911s left) gem_mmap_gtt (basic-write) [99.479211] Starting subtest: basic-write [99.607048] Subtest basic-write: SUCCESS (0.128s) [99.648066] [018/137] (910s left) gem_exec_balancer (persistence) [99.898865] Starting subtest: persistence [100.645230] Subtest persistence: SUCCESS (0.746s) [100.680489] [019/137] (909s left) i915_pm_rpm (legacy-planes) [102.196045] Starting subtest: legacy-planes [102.197446] Starting dynamic subtest: plane-40 [111.621498] Dynamic subtest plane-40: SUCCESS (9.425s) [111.632192] Starting dynamic subtest: plane-49 [120.947598] Dynamic subtest plane-49: SUCCESS (9.326s) [120.954455] Starting dynamic subtest: plane-58 [130.820635] Dynamic subtest plane-58: SUCCESS (9.872s) [130.827871] Starting dynamic subtest: plane-67 [140.240071] Dynamic subtest plane-67: SUCCESS (9.419s) [140.250150] Starting dynamic subtest: plane-76 [149.812929] Dynamic subtest plane-76: SUCCESS (9.573s) [149.818665] Starting dynamic subtest: plane-85 [159.152305] Dynamic subtest plane-85: SUCCESS (9.339s) [159.153542] Subtest legacy-planes: SUCCESS (56.956s) [159.283676] [020/137] (851s left) gem_exec_whisper (basic-queues-forked) [159.333480] Starting subtest: basic-queues-forked [163.049002] Subtest basic-queues-forked: SUCCESS (3.714s) [163.202819] [021/137] (847s left) gem_mmap_gtt (cpuset-basic-small-copy) [163.256547] Starting subtest: cpuset-basic-small-copy [166.588747] Subtest cpuset-basic-small-copy: SUCCESS (3.332s) [166.626639] [022/137] (844s left) gem_ctx_create (basic-files) [166.707596] Starting subtest: basic-files [168.715280] Subtest basic-files: SUCCESS (2.008s) [168.870493] [023/137] (841s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-fullscreen) [168.970292] Starting subtest: psr-2p-scndscrn-spr-indfb-fullscreen [168.971785] Subtest psr-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s) [169.026956] [024/137] (841s left) gem_exec_reloc (basic-cpu-read-noreloc) [169.070862] Starting subtest: basic-cpu-read-noreloc [169.073336] Subtest basic-cpu-read-noreloc: SUCCESS (0.002s) [169.151852] [025/137] (841s left) kms_frontbuffer_tracking (psr-2p-rte) [169.245478] Starting subtest: psr-2p-rte [169.247109] Subtest psr-2p-rte: SKIP (0.000s) [169.293353] [026/137] (841s left) kms_flip (2x-modeset-vs-vblank-race-interruptible) [169.369991] Starting subtest: 2x-modeset-vs-vblank-race-interruptible [169.383082] Subtest 2x-modeset-vs-vblank-race-interruptible: SKIP (0.012s) [169.418464] [027/137] (841s left) gem_lmem_swapping (massive) [169.466249] Subtest massive: SKIP (0.000s) [169.491560] [028/137] (841s left) syncobj_timeline (etime-multi-wait-for-submit-available-unsubmitted) [169.542931] Starting subtest: etime-multi-wait-for-submit-available-unsubmitted [169.656351] Subtest etime-multi-wait-for-submit-available-unsubmitted: SUCCESS (0.104s) [169.696354] [029/137] (841s left) gem_pwrite (basic-random) [169.749542] Starting subtest: basic-random [175.191985] Subtest basic-random: SUCCESS (5.441s) [175.259024] [030/137] (835s left) kms_vblank (pipe-a-ts-continuation-modeset-rpm) [175.388564] Starting subtest: pipe-A-ts-continuation-modeset-rpm [177.020307] Subtest pipe-A-ts-continuation-modeset-rpm: SUCCESS (1.631s) [177.105180] [031/137] (833s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-mmap-gtt) [177.198617] Starting subtest: psr-1p-primscrn-cur-indfb-draw-mmap-gtt [177.200003] Subtest psr-1p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s) [177.255058] [032/137] (833s left) kms_big_fb (yf-tiled-32bpp-rotate-180) [177.350730] Starting subtest: yf-tiled-32bpp-rotate-180 [177.352221] Subtest yf-tiled-32bpp-rotate-180: SKIP (0.000s) [177.396485] [033/137] (833s left) gem_eio (in-flight-1us) [177.449581] Starting subtest: in-flight-1us [179.533555] Subtest in-flight-1us: SUCCESS (2.083s) [179.607797] [034/137] (831s left) kms_frontbuffer_tracking (fbc-tiling-y) [179.701185] Starting subtest: fbc-tiling-y [180.818617] Subtest fbc-tiling-y: SUCCESS (1.118s) [180.904200] [035/137] (829s left) syncobj_timeline (invalid-single-wait-all-unsubmitted) [180.950198] Starting subtest: invalid-single-wait-all-unsubmitted [180.952026] Subtest invalid-single-wait-all-unsubmitted: SUCCESS (0.000s) [180.989663] [036/137] (829s left) perf_pmu (gt-awake) [181.043198] Starting subtest: gt-awake [184.068944] Subtest gt-awake: SUCCESS (3.025s) [184.128456] [037/137] (826s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytileccs-downscaling) [184.222117] Starting subtest: flip-32bpp-ytile-to-32bpp-ytileccs-downscaling [184.222857] Starting dynamic subtest: pipe-A-valid-mode [184.281390] Dynamic subtest pipe-A-valid-mode: SKIP (0.058s) [184.282875] Subtest flip-32bpp-ytile-to-32bpp-ytileccs-downscaling: SKIP (0.059s) [184.396559] [038/137] (826s left) kms_busy (extended-modeset-hang-oldfb) [184.492209] Starting subtest: extended-modeset-hang-oldfb [184.493991] Starting dynamic subtest: pipe-A [186.076002] Dynamic subtest pipe-A: SUCCESS (1.582s) [186.091390] Starting dynamic subtest: pipe-D [187.605470] Dynamic subtest pipe-D: SUCCESS (1.518s) [187.607326] Subtest extended-modeset-hang-oldfb: SUCCESS (3.115s) [187.720711] [039/137] (823s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-onoff) [187.813890] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-onoff [187.815312] Subtest fbcpsr-1p-primscrn-spr-indfb-onoff: SKIP (0.000s) [187.878301] [040/137] (822s left) kms_frontbuffer_tracking (fbcpsr-1p-offscren-pri-indfb-draw-mmap-wc) [187.971466] Starting subtest: fbcpsr-1p-offscren-pri-indfb-draw-mmap-wc [187.972951] Subtest fbcpsr-1p-offscren-pri-indfb-draw-mmap-wc: SKIP (0.000s) [188.029801] [041/137] (822s left) kms_ccs (pipe-d-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs) [188.451267] Starting subtest: pipe-D-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs [188.454314] Subtest pipe-D-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs: SKIP (0.002s) [188.534027] [042/137] (822s left) kms_content_protection (lic) [188.626792] Starting subtest: LIC [188.959034] Subtest LIC: SKIP (0.330s) [189.084828] [043/137] (821s left) prime_vgem (basic-write) [189.141089] Starting subtest: basic-write [189.167690] Subtest basic-write: SUCCESS (0.026s) [189.215815] [044/137] (821s left) vc4/vc4_wait_bo (bad-bo) [189.278916] Subtest bad-bo: SKIP (0.000s) [189.309302] [045/137] (821s left) syncobj_timeline (multi-wait-for-submit-available-signaled) [189.355619] Starting subtest: multi-wait-for-submit-available-signaled [189.356444] Subtest multi-wait-for-submit-available-signaled: SUCCESS (0.000s) [189.391119] [046/137] (821s left) syncobj_wait (invalid-multi-wait-unsubmitted-signaled) [189.432414] Starting subtest: invalid-multi-wait-unsubmitted-signaled [189.433216] Subtest invalid-multi-wait-unsubmitted-signaled: SUCCESS (0.000s) [189.467525] [047/137] (821s left) gem_ctx_persistence (engines-persistence) [189.514295] Starting subtest: engines-persistence [189.515101] Starting dynamic subtest: rcs0 [190.259277] Dynamic subtest rcs0: SUCCESS (0.744s) [190.268004] Starting dynamic subtest: bcs0 [191.022979] Dynamic subtest bcs0: SUCCESS (0.763s) [191.030377] Starting dynamic subtest: vcs0 [191.797067] Dynamic subtest vcs0: SUCCESS (0.773s) [191.804492] Starting dynamic subtest: vcs1 [192.565075] Dynamic subtest vcs1: SUCCESS (0.767s) [192.572603] Starting dynamic subtest: vecs0 [193.329094] Dynamic subtest vecs0: SUCCESS (0.763s) [193.330550] Subtest engines-persistence: SUCCESS (3.814s) [193.381831] [048/137] (817s left) gem_exec_schedule (u-lateslice) [193.433764] Starting subtest: u-lateslice [193.434509] Starting dynamic subtest: rcs0 [193.449698] Dynamic subtest rcs0: SUCCESS (0.016s) [193.455797] Starting dynamic subtest: bcs0 [193.464748] Dynamic subtest bcs0: SUCCESS (0.015s) [193.471155] Starting dynamic subtest: vcs0 [193.480700] Dynamic subtest vcs0: SUCCESS (0.016s) [193.487256] Starting dynamic subtest: vcs1 [193.496473] Dynamic subtest vcs1: SUCCESS (0.015s) [193.503332] Starting dynamic subtest: vecs0 [193.512545] Dynamic subtest vecs0: SUCCESS (0.016s) [193.513367] Subtest u-lateslice: SUCCESS (0.079s) [193.787032] [049/137] (817s left) kms_plane_cursor (primary) [193.891212] Starting subtest: primary [193.892881] Starting dynamic subtest: pipe-A-HDMI-A-1-size-64 [195.095592] Dynamic subtest pipe-A-HDMI-A-1-size-64: SUCCESS (1.204s) [195.126397] Starting dynamic subtest: pipe-A-HDMI-A-1-size-128 [196.320556] Dynamic subtest pipe-A-HDMI-A-1-size-128: SUCCESS (1.200s) [196.351449] Starting dynamic subtest: pipe-A-HDMI-A-1-size-256 [197.546007] Dynamic subtest pipe-A-HDMI-A-1-size-256: SUCCESS (1.200s) [197.622323] Starting dynamic subtest: pipe-B-HDMI-A-1-size-64 [198.851852] Dynamic subtest pipe-B-HDMI-A-1-size-64: SUCCESS (1.235s) [198.874813] Starting dynamic subtest: pipe-B-HDMI-A-1-size-128 [200.068767] Dynamic subtest pipe-B-HDMI-A-1-size-128: SUCCESS (1.200s) [200.090625] Starting dynamic subtest: pipe-B-HDMI-A-1-size-256 [201.285624] Dynamic subtest pipe-B-HDMI-A-1-size-256: SUCCESS (1.200s) [201.352394] Starting dynamic subtest: pipe-C-HDMI-A-1-size-64 [202.584869] Dynamic subtest pipe-C-HDMI-A-1-size-64: SUCCESS (1.238s) [202.606824] Starting dynamic subtest: pipe-C-HDMI-A-1-size-128 [203.801680] Dynamic subtest pipe-C-HDMI-A-1-size-128: SUCCESS (1.200s) [203.822480] Starting dynamic subtest: pipe-C-HDMI-A-1-size-256 [205.018767] Dynamic subtest pipe-C-HDMI-A-1-size-256: SUCCESS (1.200s) [205.085235] Starting dynamic subtest: pipe-D-HDMI-A-1-size-64 [206.317272] Dynamic subtest pipe-D-HDMI-A-1-size-64: SUCCESS (1.238s) [206.339645] Starting dynamic subtest: pipe-D-HDMI-A-1-size-128 [207.534320] Dynamic subtest pipe-D-HDMI-A-1-size-128: SUCCESS (1.200s) [207.555322] Starting dynamic subtest: pipe-D-HDMI-A-1-size-256 [208.751086] Dynamic subtest pipe-D-HDMI-A-1-size-256: SUCCESS (1.200s) [208.819540] Subtest primary: SUCCESS (14.929s) [208.904538] [050/137] (802s left) gem_exec_schedule (preempt-other) [208.961515] Starting subtest: preempt-other [208.962234] Starting dynamic subtest: rcs0 [208.985305] Dynamic subtest rcs0: SUCCESS (0.023s) [208.991643] Starting dynamic subtest: bcs0 [209.006085] Dynamic subtest bcs0: SUCCESS (0.020s) [209.011648] Starting dynamic subtest: vcs0 [209.027602] Dynamic subtest vcs0: SUCCESS (0.021s) [209.034007] Starting dynamic subtest: vcs1 [209.048786] Dynamic subtest vcs1: SUCCESS (0.021s) [209.054703] Starting dynamic subtest: vecs0 [209.069461] Dynamic subtest vecs0: SUCCESS (0.020s) [209.070262] Subtest preempt-other: SUCCESS (0.108s) [209.343171] [051/137] (801s left) kms_cursor_legacy (cursora-vs-flipb-legacy) [209.443540] Starting subtest: cursorA-vs-flipB-legacy [209.446218] Subtest cursorA-vs-flipB-legacy: SKIP (0.002s) [209.479961] [052/137] (801s left) gem_exec_flush (basic-uc-set-default) [209.526668] Starting subtest: basic-uc-set-default [214.935583] Subtest basic-uc-set-default: SUCCESS (5.409s) [215.096472] [053/137] (795s left) prime_self_import (basic-with_fd_dup) [215.159496] Starting subtest: basic-with_fd_dup [215.161246] Subtest basic-with_fd_dup: SUCCESS (0.001s) [215.231932] [054/137] (795s left) perf (invalid-oa-format-id) [215.330159] Starting subtest: invalid-oa-format-id [215.338532] Subtest invalid-oa-format-id: SUCCESS (0.009s) [215.353679] [055/137] (795s left) gem_render_copy (yf-tiled) [215.402910] Starting subtest: yf-tiled [215.403698] Starting dynamic subtest: smem [215.471102] Dynamic subtest smem: SUCCESS (0.067s) [215.471812] Subtest yf-tiled: SUCCESS (0.068s) [215.625010] [056/137] (795s left) gem_userptr_blits (sync-unmap-cycles) [215.687272] Starting subtest: sync-unmap-cycles [221.067680] Subtest sync-unmap-cycles: SUCCESS (5.380s) [221.142297] [057/137] (789s left) kms_chamelium_color (ctm-negative) [221.243280] Subtest ctm-negative: SKIP (0.000s) [221.259611] [058/137] (789s left) drm_read (short-buffer-block) [221.386443] Starting subtest: short-buffer-block [221.387242] Subtest short-buffer-block: SUCCESS (0.000s) [221.456317] [059/137] (789s left) gem_ctx_bad_destroy (invalid-default-ctx) [221.499494] Starting subtest: invalid-default-ctx [221.500194] Subtest invalid-default-ctx: SUCCESS (0.000s) [221.531120] [060/137] (789s left) kms_ccs (pipe-c-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs) [221.872818] Starting subtest: pipe-C-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs [221.875746] Subtest pipe-C-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs: SKIP (0.002s) [222.031800] [061/137] (789s left) kms_cursor_crc (cursor-random-max-size) [222.124219] Starting subtest: cursor-random-max-size [222.126439] Subtest cursor-random-max-size: SKIP (0.000s) [222.181413] [062/137] (788s left) kms_frontbuffer_tracking (psr-1p-rte) [222.275273] Starting subtest: psr-1p-rte [222.276736] Subtest psr-1p-rte: SKIP (0.000s) [222.322981] [063/137] (788s left) kms_dither (fb-8bpc-vs-panel-6bpc) [222.410486] Starting subtest: FB-8BPC-Vs-Panel-6BPC [222.411267] Starting dynamic subtest: pipe-A-HDMI-A-1 [222.459674] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.048s) [222.461324] Subtest FB-8BPC-Vs-Panel-6BPC: SKIP (0.048s) [222.553706] [064/137] (788s left) drm_fdinfo (virtual-busy) [222.598945] Starting subtest: virtual-busy [225.229314] Subtest virtual-busy: SUCCESS (2.630s) [225.270054] [065/137] (785s left) kms_psr (psr2_cursor_plane_onoff) [225.318066] Subtest psr2_cursor_plane_onoff: SKIP (0.000s) [225.343806] [066/137] (785s left) kms_ccs (pipe-a-missing-ccs-buffer-y_tiled_gen12_rc_ccs_cc) [225.516567] Starting subtest: pipe-A-missing-ccs-buffer-y_tiled_gen12_rc_ccs_cc [225.517368] Subtest pipe-A-missing-ccs-buffer-y_tiled_gen12_rc_ccs_cc: SUCCESS (0.000s) [225.848998] [067/137] (785s left) kms_ccs (pipe-b-bad-pixel-format-4_tiled_dg2_mc_ccs) [226.039110] Starting subtest: pipe-B-bad-pixel-format-4_tiled_dg2_mc_ccs [226.040577] Subtest pipe-B-bad-pixel-format-4_tiled_dg2_mc_ccs: SKIP (0.000s) [226.343096] [068/137] (784s left) gem_exec_reloc (basic-wc-gtt-active) [226.389074] Starting subtest: basic-wc-gtt-active [226.501178] Subtest basic-wc-gtt-active: SUCCESS (0.111s) [226.583925] [069/137] (784s left) fbdev (nullptr) [226.629390] Starting subtest: nullptr [226.630212] Subtest nullptr: SUCCESS (0.000s) [226.658248] [070/137] (784s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-mmap-wc) [226.756306] Starting subtest: fbcpsr-rgb101010-draw-mmap-wc [226.757922] Subtest fbcpsr-rgb101010-draw-mmap-wc: SKIP (0.000s) [226.800701] [071/137] (784s left) kms_lease (possible-crtcs-filtering) [226.887799] Starting subtest: possible-crtcs-filtering [226.891698] Subtest possible-crtcs-filtering: SUCCESS (0.004s) [226.925830] [072/137] (784s left) kms_frontbuffer_tracking (fbcpsr-slowdraw) [227.019534] Starting subtest: fbcpsr-slowdraw [227.020974] Subtest fbcpsr-slowdraw: SKIP (0.000s) [227.076281] [073/137] (784s left) kms_ccs (pipe-d-random-ccs-data-y_tiled_gen12_mc_ccs) [227.450606] Starting subtest: pipe-D-random-ccs-data-y_tiled_gen12_mc_ccs [227.452766] Subtest pipe-D-random-ccs-data-y_tiled_gen12_mc_ccs: SKIP (0.000s) [227.562996] [074/137] (783s left) kms_flip_scaled_crc (flip-64bpp-linear-to-32bpp-linear-upscaling) [227.650425] Starting subtest: flip-64bpp-linear-to-32bpp-linear-upscaling [227.652290] Starting dynamic subtest: pipe-A-valid-mode [228.388429] Dynamic subtest pipe-A-valid-mode: SUCCESS (0.737s) [228.389204] Subtest flip-64bpp-linear-to-32bpp-linear-upscaling: SUCCESS (0.738s) [228.481798] [075/137] (782s left) gem_userptr_blits (sd-probe) [228.529587] Starting subtest: sd-probe [228.530325] Subtest sd-probe: SUCCESS (0.000s) [228.606576] [076/137] (782s left) kms_ccs (pipe-c-bad-rotation-90-4_tiled_dg2_rc_ccs_cc) [228.896532] Starting subtest: pipe-C-bad-rotation-90-4_tiled_dg2_rc_ccs_cc [228.898097] Subtest pipe-C-bad-rotation-90-4_tiled_dg2_rc_ccs_cc: SKIP (0.000s) [229.121709] [077/137] (782s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-render) [229.213177] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-render [229.214554] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-render: SKIP (0.000s) [229.271481] [078/137] (782s left) gem_ctx_param (invalid-get-no-zeromap) [229.315984] Starting subtest: invalid-get-no-zeromap [229.316862] Subtest invalid-get-no-zeromap: SUCCESS (0.000s) [229.354560] [079/137] (782s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-pwrite) [229.447063] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-pwrite [229.448724] Subtest fbc-2p-scndscrn-pri-shrfb-draw-pwrite: SKIP (0.000s) [229.505694] [080/137] (781s left) kms_flip (2x-flip-vs-fences-interruptible) [229.583732] Starting subtest: 2x-flip-vs-fences-interruptible [229.596598] Subtest 2x-flip-vs-fences-interruptible: SKIP (0.012s) [229.638339] [081/137] (781s left) gem_partial_pwrite_pread (writes-after-reads-display) [229.684737] Starting subtest: writes-after-reads-display [240.748228] Subtest writes-after-reads-display: SUCCESS (11.063s) [240.813840] [082/137] (770s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-blt) [240.914252] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-blt [240.915672] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-blt: SKIP (0.000s) [240.964996] [083/137] (770s left) kms_concurrent (pipe-a) [241.052475] Starting subtest: pipe-A [241.054278] Starting dynamic subtest: HDMI-A-1 [241.383666] Dynamic subtest HDMI-A-1: SUCCESS (0.329s) [241.384392] Subtest pipe-A: SUCCESS (0.331s) [241.464569] [084/137] (769s left) i915_pm_freq_mult (media-freq) [241.507656] Starting subtest: media-freq [241.508460] Starting dynamic subtest: gt0 [241.509834] Dynamic subtest gt0: SKIP (0.000s) [241.511223] Subtest media-freq: SKIP (0.000s) [241.548202] [085/137] (769s left) kms_psr (cursor_mmap_gtt) [241.591340] Subtest cursor_mmap_gtt: SKIP (0.000s) [241.608513] [086/137] (769s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip) [241.701920] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip [241.703588] Subtest yf-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip: SKIP (0.000s) [241.764332] [087/137] (769s left) syncobj_timeline (reset-unsignaled) [241.807239] Starting subtest: reset-unsignaled [241.808002] Subtest reset-unsignaled: SUCCESS (0.000s) [241.847636] [088/137] (769s left) kms_properties (crtc-properties-legacy) [241.936703] Starting subtest: crtc-properties-legacy [242.606772] Subtest crtc-properties-legacy: SUCCESS (0.669s) [242.689624] [089/137] (768s left) kms_plane_scaling (plane-downscale-with-pixel-format-factor-0-5) [242.778390] Starting subtest: plane-downscale-with-pixel-format-factor-0-5 [242.780267] Starting dynamic subtest: pipe-A-HDMI-A-1 [250.309758] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (7.530s) [250.316110] Starting dynamic subtest: pipe-B-HDMI-A-1 [257.861369] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (7.550s) [257.868336] Starting dynamic subtest: pipe-C-HDMI-A-1 [258.051856] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.189s) [258.058218] Starting dynamic subtest: pipe-D-HDMI-A-1 [258.242900] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.189s) [258.243668] Subtest plane-downscale-with-pixel-format-factor-0-5: SUCCESS (15.464s) [258.356772] [090/137] (753s left) gem_userptr_blits (unsync-overlap) [258.405183] Subtest unsync-overlap: SKIP (0.000s) [258.472485] [091/137] (753s left) kms_invalid_mode (zero-clock) [258.564699] Starting subtest: zero-clock [258.565428] Starting dynamic subtest: HDMI-A-1-pipe-A [258.619799] Dynamic subtest HDMI-A-1-pipe-A: SUCCESS (0.055s) [258.631193] Starting dynamic subtest: HDMI-A-1-pipe-B [258.632060] Dynamic subtest HDMI-A-1-pipe-B: SUCCESS (0.008s) [258.637473] Starting dynamic subtest: HDMI-A-1-pipe-C [258.638198] Dynamic subtest HDMI-A-1-pipe-C: SUCCESS (0.001s) [258.645351] Starting dynamic subtest: HDMI-A-1-pipe-D [258.646156] Dynamic subtest HDMI-A-1-pipe-D: SUCCESS (0.001s) [258.646849] Subtest zero-clock: SUCCESS (0.072s) [258.734024] [092/137] (752s left) kms_vblank (pipe-d-wait-idle) [258.823501] Starting subtest: pipe-D-wait-idle [260.065830] Subtest pipe-D-wait-idle: SUCCESS (1.242s) [260.164627] [093/137] (751s left) gem_exec_fence (parallel) [260.319412] Starting subtest: parallel [260.320218] Starting dynamic subtest: rcs0 [262.469024] Dynamic subtest rcs0: SUCCESS (2.149s) [262.474583] Starting dynamic subtest: bcs0 [264.618302] Dynamic subtest bcs0: SUCCESS (2.149s) [264.624184] Starting dynamic subtest: vcs0 [266.768798] Dynamic subtest vcs0: SUCCESS (2.150s) [266.774465] Starting dynamic subtest: vcs1 [268.917333] Dynamic subtest vcs1: SUCCESS (2.148s) [268.922945] Starting dynamic subtest: vecs0 [271.065376] Dynamic subtest vecs0: SUCCESS (2.148s) [271.066108] Subtest parallel: SUCCESS (10.746s) [271.478799] [094/137] (740s left) gem_eio (in-flight-immediate) [271.529793] Starting subtest: in-flight-immediate [273.638258] Subtest in-flight-immediate: SUCCESS (2.109s) [273.711550] [095/137] (737s left) kms_vblank (pipe-d-query-busy-hang) [273.799810] Starting subtest: pipe-D-query-busy-hang [275.314696] Subtest pipe-D-query-busy-hang: SUCCESS (1.515s) [275.412742] [096/137] (736s left) gem_exec_reloc (basic-wc-cpu-noreloc) [275.457771] Starting subtest: basic-wc-cpu-noreloc [275.460352] Subtest basic-wc-cpu-noreloc: SUCCESS (0.003s) [275.546399] [097/137] (736s left) syncobj_timeline (invalid-multi-wait-all-available-unsubmitted-submitted-sign [275.590956] Starting subtest: invalid-multi-wait-all-available-unsubmitted-submitted-signaled [275.591697] Subtest invalid-multi-wait-all-available-unsubmitted-submitted-signaled: SUCCESS (0.000s) [275.629678] [098/137] (735s left) kms_plane_scaling (plane-scaler-with-rotation-unity-scaling) [275.717692] Starting subtest: plane-scaler-with-rotation-unity-scaling [275.718425] Starting dynamic subtest: pipe-A-HDMI-A-1 [275.757534] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.038s) [275.764170] Starting dynamic subtest: pipe-B-HDMI-A-1 [275.856603] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.097s) [275.862058] Starting dynamic subtest: pipe-C-HDMI-A-1 [275.946567] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.088s) [275.953159] Starting dynamic subtest: pipe-D-HDMI-A-1 [276.054559] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.106s) [276.056137] Subtest plane-scaler-with-rotation-unity-scaling: SKIP (0.336s) [276.184975] [099/137] (735s left) gem_wait (wait) [276.236838] Starting subtest: wait [276.237622] Starting dynamic subtest: all-engines [277.255825] Dynamic subtest all-engines: SUCCESS (1.018s) [277.264708] Starting dynamic subtest: rcs0 [278.271799] Dynamic subtest rcs0: SUCCESS (1.015s) [278.280600] Starting dynamic subtest: bcs0 [279.291842] Dynamic subtest bcs0: SUCCESS (1.019s) [279.300531] Starting dynamic subtest: vcs0 [280.314218] Dynamic subtest vcs0: SUCCESS (1.021s) [280.322716] Starting dynamic subtest: vcs1 [281.332027] Dynamic subtest vcs1: SUCCESS (1.017s) [281.340706] Starting dynamic subtest: vecs0 [282.347754] Dynamic subtest vecs0: SUCCESS (1.015s) [282.348809] Subtest wait: SUCCESS (6.111s) [282.508761] [100/137] (729s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-mmap-gtt) [282.604666] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-mmap-gtt [282.606042] Subtest fbc-2p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s) [282.652643] [101/137] (728s left) kms_flip (2x-flip-vs-panning-vs-hang) [282.727231] Starting subtest: 2x-flip-vs-panning-vs-hang [282.738490] Subtest 2x-flip-vs-panning-vs-hang: SKIP (0.012s) [282.779634] [102/137] (728s left) gem_ctx_shared (q-smoketest) [282.845164] Starting subtest: Q-smoketest [282.845926] Starting dynamic subtest: rcs0 [288.250147] Dynamic subtest rcs0: SUCCESS (5.399s) [288.255657] Starting dynamic subtest: bcs0 [293.658924] Dynamic subtest bcs0: SUCCESS (5.408s) [293.665216] Starting dynamic subtest: vcs0 [299.065550] Dynamic subtest vcs0: SUCCESS (5.406s) [299.072686] Starting dynamic subtest: vcs1 [304.470275] Dynamic subtest vcs1: SUCCESS (5.405s) [304.477069] Starting dynamic subtest: vecs0 [309.870705] Dynamic subtest vecs0: SUCCESS (5.400s) [309.871421] Subtest Q-smoketest: SUCCESS (27.020s) [310.026723] [103/137] (701s left) kms_big_fb (x-tiled-64bpp-rotate-0) [310.131421] Starting subtest: x-tiled-64bpp-rotate-0 [311.610658] Subtest x-tiled-64bpp-rotate-0: SUCCESS (1.479s) [311.788574] [104/137] (699s left) gem_mmap (short-mmap) [311.834356] Starting subtest: short-mmap [311.835118] Subtest short-mmap: SUCCESS (0.000s) [311.887699] [105/137] (699s left) kms_big_fb (x-tiled-32bpp-rotate-270) [311.988914] Starting subtest: x-tiled-32bpp-rotate-270 [312.039094] Subtest x-tiled-32bpp-rotate-270: SKIP (0.049s) [312.107486] [106/137] (699s left) perf (enable-disable) [312.183668] Starting subtest: enable-disable [312.184504] Starting dynamic subtest: 0-rcs0 [314.376525] Dynamic subtest 0-rcs0: SUCCESS (2.192s) [314.377379] Subtest enable-disable: SUCCESS (2.192s) [314.396903] [107/137] (697s left) gem_ppgtt (shrink-vs-evict-any) [314.457349] Starting subtest: shrink-vs-evict-any [319.526231] Subtest shrink-vs-evict-any: SUCCESS (5.069s) [319.585975] [108/137] (692s left) i915_pm_backlight (basic-brightness) [319.677409] Subtest basic-brightness: SKIP (0.000s) [319.694024] [109/137] (692s left) syncobj_wait (multi-wait-all-submitted) [319.736572] Starting subtest: multi-wait-all-submitted [319.840837] Subtest multi-wait-all-submitted: SUCCESS (0.102s) [319.886846] [110/137] (691s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-blt) [319.988137] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-blt [319.989626] Subtest fbc-2p-scndscrn-pri-shrfb-draw-blt: SKIP (0.000s) [320.049892] [111/137] (691s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0-hflip) [320.142717] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0-hflip [320.144236] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0-hflip: SKIP (0.000s) [320.191691] [112/137] (691s left) kms_chamelium_hpd (hdmi-hpd-with-enabled-mode) [320.329847] Subtest hdmi-hpd-with-enabled-mode: SKIP (0.000s) [320.382953] [113/137] (691s left) kms_ccs (pipe-b-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs_cc) [320.646248] Starting subtest: pipe-B-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs_cc [320.649079] Subtest pipe-B-crc-sprite-planes-basic-4_tiled_dg2_rc_ccs_cc: SKIP (0.002s) [320.881799] [114/137] (690s left) kms_plane_scaling (planes-upscale-factor-0-25) [320.969620] Starting subtest: planes-upscale-factor-0-25 [320.970334] Starting dynamic subtest: pipe-A-HDMI-A-1 [321.025692] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.055s) [321.032472] Starting dynamic subtest: pipe-B-HDMI-A-1 [321.142665] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.115s) [321.149051] Starting dynamic subtest: pipe-C-HDMI-A-1 [321.251386] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.107s) [321.259502] Starting dynamic subtest: pipe-D-HDMI-A-1 [321.368645] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.115s) [321.369484] Subtest planes-upscale-factor-0-25: SUCCESS (0.400s) [321.481902] [115/137] (690s left) kms_color (ctm-0-75) [321.570353] Starting subtest: ctm-0-75 [321.572158] Starting dynamic subtest: pipe-A-HDMI-A-1 [323.510462] Dynamic subtest pipe-A-HDMI-A-1: FAIL (1.893s) [323.515945] Starting dynamic subtest: pipe-B-HDMI-A-1 [325.621646] Dynamic subtest pipe-B-HDMI-A-1: FAIL (2.101s) [325.627232] Starting dynamic subtest: pipe-C-HDMI-A-1 [327.919764] Dynamic subtest pipe-C-HDMI-A-1: FAIL (2.293s) [327.926497] Starting dynamic subtest: pipe-D-HDMI-A-1 [330.445022] Dynamic subtest pipe-D-HDMI-A-1: FAIL (2.529s) [330.445715] Subtest ctm-0-75: FAIL (8.829s) [330.473523] [116/137] (681s left) v3d/v3d_perfmon (create-perfmon-exceed) [330.542189] Subtest create-perfmon-exceed: SKIP (0.000s) [330.571367] [117/137] (681s left) kms_cursor_legacy (cursor-vs-flip-toggle) [330.664186] Starting subtest: cursor-vs-flip-toggle [359.204091] Subtest cursor-vs-flip-toggle: SUCCESS (28.540s) [359.302385] [118/137] (652s left) i915_hangman (engine-engine-error) [359.351356] Starting subtest: engine-engine-error [359.352103] Starting dynamic subtest: rcs0 [359.399419] Dynamic subtest rcs0: SUCCESS (0.049s) [359.405342] Starting dynamic subtest: bcs0 [359.442447] Dynamic subtest bcs0: SUCCESS (0.043s) [359.448540] Starting dynamic subtest: vcs0 [359.497404] Dynamic subtest vcs0: SUCCESS (0.055s) [359.503265] Starting dynamic subtest: vcs1 [359.552488] Dynamic subtest vcs1: SUCCESS (0.055s) [359.560320] Starting dynamic subtest: vecs0 [359.603139] Dynamic subtest vecs0: SUCCESS (0.050s) [359.604558] Subtest engine-engine-error: SUCCESS (0.252s) [359.683023] [119/137] (652s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-render) [359.778776] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-render [359.780172] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-render: SKIP (0.000s) [359.835204] [120/137] (652s left) gem_exec_fair (basic-pace-share) [359.885192] Starting subtest: basic-pace-share [359.885999] Starting dynamic subtest: rcs0 [364.236697] Dynamic subtest rcs0: FAIL (4.335s) [364.237409] Subtest basic-pace-share: FAIL (4.335s) [364.401088] [121/137] (647s left) kms_scaling_modes (scaling-mode-full) [364.494654] Starting subtest: scaling-mode-full [364.497751] Subtest scaling-mode-full: SKIP (0.003s) [364.535958] [122/137] (647s left) perf (disabled-read-error) [364.611621] Starting subtest: disabled-read-error [364.624566] Subtest disabled-read-error: SUCCESS (0.013s) [364.640908] [123/137] (647s left) kms_atomic (atomic_plane_damage) [364.773174] Starting subtest: atomic_plane_damage [364.924516] Subtest atomic_plane_damage: SUCCESS (0.151s) [365.081746] [124/137] (646s left) api_intel_bb (purge-bb) [365.123576] Starting subtest: purge-bb [365.125400] Subtest purge-bb: SUCCESS (0.002s) [365.197738] [125/137] (646s left) kms_ccs (pipe-c-bad-rotation-90-4_tiled_dg2_rc_ccs) [365.472246] Starting subtest: pipe-C-bad-rotation-90-4_tiled_dg2_rc_ccs [365.473720] Subtest pipe-C-bad-rotation-90-4_tiled_dg2_rc_ccs: SKIP (0.000s) [365.688505] [126/137] (646s left) syncobj_wait (invalid-single-wait-all-unsubmitted) [365.730673] Starting subtest: invalid-single-wait-all-unsubmitted [365.731400] Subtest invalid-single-wait-all-unsubmitted: SUCCESS (0.000s) [365.763674] [127/137] (646s left) i915_pm_rps (waitboost) [365.807377] Starting subtest: waitboost [368.325411] Subtest waitboost: SUCCESS (2.518s) [368.400335] [128/137] (643s left) api_intel_allocator (alloc-simple) [368.451131] Starting subtest: alloc-simple [368.451916] Subtest alloc-simple: SUCCESS (0.001s) [368.523877] [129/137] (643s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-0-hflip) [368.627725] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-0-hflip [369.267960] Subtest y-tiled-max-hw-stride-32bpp-rotate-0-hflip: SUCCESS (0.640s) [369.356006] [130/137] (642s left) gem_wait (invalid-buf) [369.402504] Starting subtest: invalid-buf [369.403283] Subtest invalid-buf: SUCCESS (0.000s) [369.583346] [131/137] (642s left) kms_ccs (pipe-a-ccs-on-another-bo-yf_tiled_ccs) [369.762122] Starting subtest: pipe-A-ccs-on-another-bo-yf_tiled_ccs [369.763599] Subtest pipe-A-ccs-on-another-bo-yf_tiled_ccs: SKIP (0.000s) [370.089385] [132/137] (641s left) kms_cursor_edge_walk (256x256-top-edge) [370.177841] Starting subtest: 256x256-top-edge [370.178599] Starting dynamic subtest: pipe-A-HDMI-A-1 [371.936718] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (1.758s) [371.946371] Starting dynamic subtest: pipe-D-HDMI-A-1 [373.606564] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (1.667s) [373.607388] Subtest 256x256-top-edge: SUCCESS (3.430s) [373.679631] [133/137] (638s left) vc4/vc4_create_bo (create-bo-0) [373.740786] Subtest create-bo-0: SKIP (0.000s) [373.774603] [134/137] (638s left) kms_frontbuffer_tracking (fbc-1p-rte) [373.868901] Starting subtest: fbc-1p-rte [376.620172] Subtest fbc-1p-rte: SUCCESS (2.752s) [376.709086] [135/137] (635s left) gem_softpin (allocator-evict) [376.761154] Starting subtest: allocator-evict [376.761867] Starting dynamic subtest: rcs0 [400.391628] Dynamic subtest rcs0: SUCCESS (23.630s) [400.398160] Starting dynamic subtest: bcs0 [423.714621] Dynamic subtest bcs0: SUCCESS (23.323s) [423.720962] Starting dynamic subtest: vcs0 [446.781622] Dynamic subtest vcs0: SUCCESS (23.067s) [446.788395] Starting dynamic subtest: vcs1 [469.892032] Dynamic subtest vcs1: SUCCESS (23.110s) [469.897854] Starting dynamic subtest: vecs0 [493.111654] Dynamic subtest vecs0: SUCCESS (23.219s) [493.112526] Subtest allocator-evict: SUCCESS (116.350s) [493.151192] [136/137] (518s left) gem_exec_schedule (fairslice-all) [493.235215] Starting subtest: fairslice-all [495.263552] Subtest fairslice-all: SUCCESS (2.028s) [495.537645] [137/137] (516s left) kms_rotation_crc (cursor-rotation-180) [495.638234] Starting subtest: cursor-rotation-180 [495.972101] Subtest cursor-rotation-180: SUCCESS (0.334s) [496.107316] Closing watchdogs Done.