[51.238569] Initializing watchdogs [51.238632] /dev/watchdog0 [51.253585] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:9a49 Intel Tigerlake (Gen12) TigerLake-LP GT2 [Iris Xe Graphics] [51.259075] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [51.261521] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [51.263880] [001/133] (960s left) gem_softpin (noreloc-s3) [51.309573] Starting subtest: noreloc-S3 [71.939550] Subtest noreloc-S3: SUCCESS (5.419s) [76.060792] [002/133] (939s left) perf_pmu (gt-awake) [76.108772] Starting subtest: gt-awake [79.147802] Subtest gt-awake: SUCCESS (3.029s) [79.223925] [003/133] (936s left) kms_invalid_mode (zero-hdisplay) [79.311736] Starting subtest: zero-hdisplay [79.312484] Starting dynamic subtest: pipe-A-HDMI-A-1 [79.365769] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.054s) [79.373574] Starting dynamic subtest: pipe-B-HDMI-A-1 [79.374328] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.001s) [79.381939] Starting dynamic subtest: pipe-C-HDMI-A-1 [79.382694] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.001s) [79.391357] Starting dynamic subtest: pipe-D-HDMI-A-1 [79.392164] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.001s) [79.392848] Subtest zero-hdisplay: SUCCESS (0.060s) [79.509298] [004/133] (936s left) kms_prop_blob (invalid-set-prop-any) [79.545322] Starting subtest: invalid-set-prop-any [79.546039] Subtest invalid-set-prop-any: SUCCESS (0.000s) [79.598342] [005/133] (936s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-move) [79.687865] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-move [79.689221] Subtest fbcpsr-1p-primscrn-spr-indfb-move: SKIP (0.000s) [79.786214] [006/133] (936s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc) [79.873861] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc [79.875206] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s) [79.946013] [007/133] (936s left) kms_cursor_legacy (torture-move) [80.031314] Starting subtest: torture-move [80.032035] Starting dynamic subtest: pipe-A [85.568379] Dynamic subtest pipe-A: SUCCESS (5.500s) [85.576732] Starting dynamic subtest: pipe-B [91.644151] Dynamic subtest pipe-B: SUCCESS (6.075s) [91.653348] Starting dynamic subtest: pipe-C [97.108102] Dynamic subtest pipe-C: SUCCESS (5.463s) [97.116095] Starting dynamic subtest: pipe-D [102.560028] Dynamic subtest pipe-D: SUCCESS (5.485s) [102.567560] Starting dynamic subtest: all-pipes [108.193912] Dynamic subtest all-pipes: SUCCESS (5.625s) [108.194598] Subtest torture-move: SUCCESS (28.151s) [108.242599] [008/133] (907s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-mmap-wc) [108.332977] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-mmap-wc [109.558001] Subtest fbc-1p-primscrn-spr-indfb-draw-mmap-wc: SUCCESS (1.225s) [109.686060] [009/133] (906s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-blt) [109.774787] Starting subtest: fbc-rgb101010-draw-blt [112.249968] Subtest fbc-rgb101010-draw-blt: SUCCESS (2.475s) [112.366114] [010/133] (903s left) gem_pxp (create-regular-context-2) [112.467714] Starting subtest: create-regular-context-2 [112.469023] Subtest create-regular-context-2: SUCCESS (0.001s) [112.532228] [011/133] (903s left) kms_flip (2x-flip-vs-panning-interruptible) [112.620723] Starting subtest: 2x-flip-vs-panning-interruptible [112.630547] Subtest 2x-flip-vs-panning-interruptible: SKIP (0.009s) [112.694400] [012/133] (903s left) kms_plane_alpha_blend (constant-alpha-max) [112.778136] Starting subtest: constant-alpha-max [112.847169] Starting dynamic subtest: pipe-A-HDMI-A-1 [113.333228] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.486s) [113.342420] Starting dynamic subtest: pipe-D-HDMI-A-1 [113.835806] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.501s) [113.836545] Subtest constant-alpha-max: SUCCESS (1.057s) [114.003535] [013/133] (902s left) kms_plane (pixel-format-4-tiled-mtl-rc-ccs-modifier) [114.091932] Starting subtest: pixel-format-4-tiled-mtl-rc-ccs-modifier [114.093330] Subtest pixel-format-4-tiled-mtl-rc-ccs-modifier: SKIP (0.000s) [114.145632] [014/133] (902s left) gem_mmap_gtt (basic-write-cpu-read-gtt) [114.177699] Starting subtest: basic-write-cpu-read-gtt [114.413319] Subtest basic-write-cpu-read-gtt: SUCCESS (0.227s) [114.484919] [015/133] (901s left) kms_pipe_b_c_ivb (disable-pipe-b-enable-pipe-c) [114.518039] Subtest disable-pipe-B-enable-pipe-C: SKIP (0.000s) [114.561149] [016/133] (901s left) gem_vm_create (invalid-destroy) [114.597175] Starting subtest: invalid-destroy [114.597850] Subtest invalid-destroy: SUCCESS (0.001s) [114.678987] [017/133] (901s left) gem_lmem_swapping (heavy-verify-random-ccs) [114.715673] Subtest heavy-verify-random-ccs: SKIP (0.000s) [114.756697] [018/133] (901s left) kms_feature_discovery (display-2x) [114.842808] Starting subtest: display-2x [114.844161] Subtest display-2x: SKIP (0.000s) [114.895198] [019/133] (901s left) kms_ccs (bad-rotation-90-4-tiled-dg2-rc-ccs-cc) [114.978181] Starting subtest: bad-rotation-90-4-tiled-dg2-rc-ccs-cc [114.978905] Starting dynamic subtest: pipe-A-HDMI-A-1 [114.985861] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.000s) [114.994297] Starting dynamic subtest: pipe-B-HDMI-A-1 [115.001114] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.000s) [115.009328] Starting dynamic subtest: pipe-C-HDMI-A-1 [115.016137] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.000s) [115.024073] Starting dynamic subtest: pipe-D-HDMI-A-1 [115.031098] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.000s) [115.032416] Subtest bad-rotation-90-4-tiled-dg2-rc-ccs-cc: SKIP (0.004s) [115.219311] [020/133] (901s left) gem_mmap_offset (blt-coherency) [115.253266] Starting subtest: blt-coherency [115.259214] Subtest blt-coherency: SUCCESS (0.006s) [115.381089] [021/133] (901s left) gem_pxp (hw-rejects-pxp-context) [115.415047] Starting subtest: hw-rejects-pxp-context [115.416456] Subtest hw-rejects-pxp-context: SKIP (0.000s) [115.493198] [022/133] (901s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-mmap-cpu) [115.580945] Starting subtest: psr-1p-primscrn-spr-indfb-draw-mmap-cpu [115.582338] Subtest psr-1p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s) [115.677361] [023/133] (900s left) kms_psr (pr-sprite-mmap-gtt) [115.762515] Subtest pr-sprite-mmap-gtt: SKIP (0.000s) [115.801564] [024/133] (900s left) gem_exec_reloc (basic-write-gtt-noreloc) [115.839074] Starting subtest: basic-write-gtt-noreloc [115.842773] Subtest basic-write-gtt-noreloc: SUCCESS (0.004s) [115.970095] [025/133] (900s left) kms_color_pipeline (plane-lut1d-ctm3x4) [116.056032] Starting subtest: plane-lut1d-ctm3x4 [116.140916] Starting dynamic subtest: pipe-A-plane-0 [116.241007] Dynamic subtest pipe-A-plane-0: SUCCESS (0.100s) [116.255574] Starting dynamic subtest: pipe-A-plane-1 [116.340841] Dynamic subtest pipe-A-plane-1: SUCCESS (0.099s) [116.351555] Starting dynamic subtest: pipe-A-plane-2 [116.432506] Dynamic subtest pipe-A-plane-2: SUCCESS (0.091s) [116.629965] Starting dynamic subtest: pipe-B-plane-0 [116.705756] Dynamic subtest pipe-B-plane-0: SUCCESS (0.084s) [116.717610] Starting dynamic subtest: pipe-B-plane-1 [116.797523] Dynamic subtest pipe-B-plane-1: SUCCESS (0.091s) [116.809068] Starting dynamic subtest: pipe-B-plane-2 [116.897142] Dynamic subtest pipe-B-plane-2: SUCCESS (0.099s) [117.113797] Starting dynamic subtest: pipe-C-plane-0 [117.191675] Dynamic subtest pipe-C-plane-0: SUCCESS (0.084s) [117.203178] Starting dynamic subtest: pipe-C-plane-1 [117.291375] Dynamic subtest pipe-C-plane-1: SUCCESS (0.099s) [117.301358] Starting dynamic subtest: pipe-C-plane-2 [117.391378] Dynamic subtest pipe-C-plane-2: SUCCESS (0.099s) [117.578041] Starting dynamic subtest: pipe-D-plane-0 [117.663954] Dynamic subtest pipe-D-plane-0: SUCCESS (0.092s) [117.674325] Starting dynamic subtest: pipe-D-plane-1 [117.763948] Dynamic subtest pipe-D-plane-1: SUCCESS (0.099s) [117.775095] Starting dynamic subtest: pipe-D-plane-2 [117.863853] Dynamic subtest pipe-D-plane-2: SUCCESS (0.099s) [117.919621] Subtest plane-lut1d-ctm3x4: SUCCESS (1.864s) [118.029800] [026/133] (898s left) gem_exec_schedule (preempt-hang) [118.200398] Starting subtest: preempt-hang [118.201509] Starting dynamic subtest: rcs0 [118.406474] Dynamic subtest rcs0: SUCCESS (0.214s) [118.414417] Starting dynamic subtest: bcs0 [118.605074] Dynamic subtest bcs0: SUCCESS (0.198s) [118.615098] Starting dynamic subtest: vcs0 [118.810952] Dynamic subtest vcs0: SUCCESS (0.206s) [118.818533] Starting dynamic subtest: vcs1 [119.010660] Dynamic subtest vcs1: SUCCESS (0.199s) [119.019886] Starting dynamic subtest: vecs0 [119.211687] Dynamic subtest vecs0: SUCCESS (0.201s) [119.212708] Subtest preempt-hang: SUCCESS (1.020s) [119.392971] [027/133] (897s left) kms_psr (psr-cursor-mmap-cpu) [119.478610] Subtest psr-cursor-mmap-cpu: SKIP (0.000s) [119.516061] [028/133] (897s left) gem_exec_whisper (basic-contexts-priority-all) [119.559658] Starting subtest: basic-contexts-priority-all [123.109965] Subtest basic-contexts-priority-all: SUCCESS (3.541s) [123.287682] [029/133] (893s left) gem_exec_reloc (basic-gtt-wc-noreloc) [123.324181] Starting subtest: basic-gtt-wc-noreloc [123.327942] Subtest basic-gtt-wc-noreloc: SUCCESS (0.004s) [123.435844] [030/133] (893s left) kms_cursor_legacy (cursorb-vs-flipa-atomic-transitions) [123.520065] Starting subtest: cursorB-vs-flipA-atomic-transitions [123.522706] Subtest cursorB-vs-flipA-atomic-transitions: SKIP (0.002s) [123.578050] [031/133] (893s left) gem_exec_params (rel-constants-invalid) [123.613878] Starting subtest: rel-constants-invalid [123.614597] Subtest rel-constants-invalid: SUCCESS (0.000s) [123.704606] [032/133] (893s left) kms_joiner (invalid-modeset-ultra-joiner) [123.789164] Starting subtest: invalid-modeset-ultra-joiner [123.790535] Subtest invalid-modeset-ultra-joiner: SKIP (0.000s) [123.847076] [033/133] (893s left) syncobj_wait (invalid-signal-bad-pad) [123.879882] Starting subtest: invalid-signal-bad-pad [123.880620] Subtest invalid-signal-bad-pad: SUCCESS (0.000s) [123.940553] [034/133] (893s left) kms_flip (2x-flip-vs-dpms-off-vs-modeset-interruptible) [124.028559] Starting subtest: 2x-flip-vs-dpms-off-vs-modeset-interruptible [124.038167] Subtest 2x-flip-vs-dpms-off-vs-modeset-interruptible: SKIP (0.009s) [124.125534] [035/133] (892s left) gem_eio (in-flight-contexts-1us) [124.168876] Starting subtest: in-flight-contexts-1us [138.035920] Subtest in-flight-contexts-1us: SUCCESS (13.864s) [138.156577] [036/133] (878s left) kms_pm_lpsp (kms-lpsp) [139.246576] Starting subtest: kms-lpsp [139.247911] Subtest kms-lpsp: SKIP (0.000s) [139.297599] [037/133] (877s left) i915_drm_fdinfo (busy-check-all) [139.331730] Starting subtest: busy-check-all [139.332471] Starting dynamic subtest: rcs0 [139.850675] Dynamic subtest rcs0: SUCCESS (0.518s) [139.860773] Starting dynamic subtest: bcs0 [140.377917] Dynamic subtest bcs0: SUCCESS (0.526s) [140.388136] Starting dynamic subtest: vcs0 [140.898767] Dynamic subtest vcs0: SUCCESS (0.519s) [140.908285] Starting dynamic subtest: vcs1 [141.418991] Dynamic subtest vcs1: SUCCESS (0.520s) [141.429050] Starting dynamic subtest: vecs0 [141.939769] Dynamic subtest vecs0: SUCCESS (0.520s) [141.940860] Subtest busy-check-all: SUCCESS (2.608s) [142.008025] [038/133] (875s left) drm_read (fault-buffer) [142.142441] Starting subtest: fault-buffer [142.143285] Subtest fault-buffer: SUCCESS (0.001s) [142.260416] [039/133] (874s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0) [142.356468] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0 [143.041608] Subtest x-tiled-max-hw-stride-32bpp-rotate-0: SUCCESS (0.685s) [143.151858] [040/133] (874s left) kms_ccs (crc-primary-basic-4-tiled-mtl-rc-ccs) [143.236865] Starting subtest: crc-primary-basic-4-tiled-mtl-rc-ccs [143.237550] Starting dynamic subtest: pipe-A-HDMI-A-1 [143.244086] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.001s) [143.251566] Starting dynamic subtest: pipe-B-HDMI-A-1 [143.258060] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.001s) [143.265790] Starting dynamic subtest: pipe-C-HDMI-A-1 [143.272408] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.001s) [143.279735] Starting dynamic subtest: pipe-D-HDMI-A-1 [143.286380] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.001s) [143.287737] Subtest crc-primary-basic-4-tiled-mtl-rc-ccs: SKIP (0.007s) [143.486406] [041/133] (873s left) gem_ctx_shared (create-shared-gtt) [143.527680] Starting subtest: create-shared-gtt [145.685320] Subtest create-shared-gtt: SUCCESS (2.149s) [145.859179] [042/133] (871s left) gem_sync (basic-store-each) [145.899924] Starting subtest: basic-store-each [148.076779] Subtest basic-store-each: SUCCESS (2.177s) [148.273965] [043/133] (869s left) kms_flip (flip-vs-absolute-wf_vblank-interruptible) [148.363872] Starting subtest: flip-vs-absolute-wf_vblank-interruptible [148.366441] Starting dynamic subtest: A-HDMI-A1 [156.187835] Dynamic subtest A-HDMI-A1: SUCCESS (7.803s) [156.198101] Starting dynamic subtest: B-HDMI-A1 [163.967733] Dynamic subtest B-HDMI-A1: SUCCESS (7.770s) [163.978660] Starting dynamic subtest: C-HDMI-A1 [171.755660] Dynamic subtest C-HDMI-A1: SUCCESS (7.786s) [171.763209] Starting dynamic subtest: D-HDMI-A1 [179.518659] Dynamic subtest D-HDMI-A1: SUCCESS (7.784s) [179.519358] Subtest flip-vs-absolute-wf_vblank-interruptible: SUCCESS (31.151s) [179.690720] [044/133] (837s left) i915_pm_freq_api (freq-basic-api) [179.727049] Subtest freq-basic-api: SKIP (0.000s) [179.770080] [045/133] (837s left) kms_atomic_transition (plane-use-after-nonblocking-unbind) [179.857055] Starting subtest: plane-use-after-nonblocking-unbind [179.857768] Starting dynamic subtest: pipe-A-HDMI-A-1 [179.914412] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.057s) [179.973514] Starting dynamic subtest: pipe-B-HDMI-A-1 [180.126350] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.162s) [180.184354] Subtest plane-use-after-nonblocking-unbind: SUCCESS (0.328s) [180.318440] [046/133] (837s left) kms_frontbuffer_tracking (psr-2p-primscrn-shrfb-msflip-blt) [180.406949] Starting subtest: psr-2p-primscrn-shrfb-msflip-blt [180.408314] Subtest psr-2p-primscrn-shrfb-msflip-blt: SKIP (0.000s) [180.493051] [047/133] (837s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-mmap-gtt) [180.581976] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-mmap-gtt [180.583392] Subtest psr-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [180.651494] [048/133] (836s left) kms_getfb (getfb2-handle-closed) [180.735036] Starting subtest: getfb2-handle-closed [180.735758] Subtest getfb2-handle-closed: SUCCESS (0.000s) [180.839025] [049/133] (836s left) kms_psr (fbc-pr-no-drrs) [180.923722] Subtest fbc-pr-no-drrs: SKIP (0.000s) [180.971515] [050/133] (836s left) drm_read (short-buffer-nonblock) [181.076714] Starting subtest: short-buffer-nonblock [181.077460] Subtest short-buffer-nonblock: SUCCESS (0.000s) [181.188310] [051/133] (836s left) gen9_exec_parse (bb-secure) [181.225049] Subtest bb-secure: SKIP (0.000s) [181.286684] [052/133] (836s left) kms_psr (fbc-pr-sprite-render) [181.371736] Subtest fbc-pr-sprite-render: SKIP (0.000s) [181.412474] [053/133] (836s left) kms_big_fb (linear-64bpp-rotate-0) [181.506604] Starting subtest: linear-64bpp-rotate-0 [183.169008] Subtest linear-64bpp-rotate-0: SUCCESS (1.662s) [183.288033] [054/133] (834s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-64bpp-ytile-upscaling) [183.373823] Starting subtest: flip-32bpp-ytile-to-64bpp-ytile-upscaling [183.374496] Starting dynamic subtest: pipe-A-valid-mode [184.175345] Dynamic subtest pipe-A-valid-mode: SUCCESS (0.800s) [184.176026] Subtest flip-32bpp-ytile-to-64bpp-ytile-upscaling: SUCCESS (0.802s) [184.325872] [055/133] (833s left) gem_exec_balancer (full) [184.369179] Starting subtest: full [185.947687] Subtest full: SUCCESS (1.578s) [186.131077] [056/133] (831s left) kms_plane_scaling (plane-upscale-20x20-with-pixel-format) [186.216973] Starting subtest: plane-upscale-20x20-with-pixel-format [186.217664] Starting dynamic subtest: pipe-A [187.334332] Dynamic subtest pipe-A: SUCCESS (1.117s) [187.343949] Starting dynamic subtest: pipe-B [188.501187] Dynamic subtest pipe-B: SUCCESS (1.167s) [188.508841] Starting dynamic subtest: pipe-C [188.702365] Dynamic subtest pipe-C: SUCCESS (0.201s) [188.710943] Starting dynamic subtest: pipe-D [188.902183] Dynamic subtest pipe-D: SUCCESS (0.199s) [188.902972] Subtest plane-upscale-20x20-with-pixel-format: SUCCESS (2.686s) [189.089883] [057/133] (828s left) kms_flip (modeset-vs-vblank-race-interruptible) [189.182999] Starting subtest: modeset-vs-vblank-race-interruptible [189.185648] Starting dynamic subtest: A-HDMI-A1 [192.042813] Dynamic subtest A-HDMI-A1: SUCCESS (2.857s) [192.051665] Starting dynamic subtest: B-HDMI-A1 [194.896154] Dynamic subtest B-HDMI-A1: SUCCESS (2.851s) [194.904032] Starting dynamic subtest: C-HDMI-A1 [197.745137] Dynamic subtest C-HDMI-A1: SUCCESS (2.848s) [197.753833] Starting dynamic subtest: D-HDMI-A1 [200.523836] Dynamic subtest D-HDMI-A1: SUCCESS (2.777s) [200.526996] Subtest modeset-vs-vblank-race-interruptible: SUCCESS (11.343s) [200.674455] [058/133] (817s left) i915_pm_rps (engine-order) [200.722654] Starting subtest: engine-order [204.406406] Subtest engine-order: SUCCESS (3.674s) [204.504933] [059/133] (813s left) kms_plane_cursor (overlay) [204.591372] Starting subtest: overlay [204.592806] Starting dynamic subtest: pipe-A-HDMI-A-1-size-64 [205.983118] Dynamic subtest pipe-A-HDMI-A-1-size-64: SUCCESS (1.390s) [206.028146] Starting dynamic subtest: pipe-A-HDMI-A-1-size-128 [207.408123] Dynamic subtest pipe-A-HDMI-A-1-size-128: SUCCESS (1.391s) [207.452190] Starting dynamic subtest: pipe-A-HDMI-A-1-size-256 [208.825356] Dynamic subtest pipe-A-HDMI-A-1-size-256: SUCCESS (1.383s) [208.910823] Starting dynamic subtest: pipe-B-HDMI-A-1-size-64 [210.400422] Dynamic subtest pipe-B-HDMI-A-1-size-64: SUCCESS (1.496s) [210.433857] Starting dynamic subtest: pipe-B-HDMI-A-1-size-128 [211.825593] Dynamic subtest pipe-B-HDMI-A-1-size-128: SUCCESS (1.400s) [211.862839] Starting dynamic subtest: pipe-B-HDMI-A-1-size-256 [213.276141] Dynamic subtest pipe-B-HDMI-A-1-size-256: SUCCESS (1.425s) [213.361221] Starting dynamic subtest: pipe-C-HDMI-A-1-size-64 [214.765119] Dynamic subtest pipe-C-HDMI-A-1-size-64: SUCCESS (1.413s) [214.801292] Starting dynamic subtest: pipe-C-HDMI-A-1-size-128 [216.165590] Dynamic subtest pipe-C-HDMI-A-1-size-128: SUCCESS (1.375s) [216.203174] Starting dynamic subtest: pipe-C-HDMI-A-1-size-256 [217.590857] Dynamic subtest pipe-C-HDMI-A-1-size-256: SUCCESS (1.400s) [217.670528] Starting dynamic subtest: pipe-D-HDMI-A-1-size-64 [219.079891] Dynamic subtest pipe-D-HDMI-A-1-size-64: SUCCESS (1.419s) [219.117650] Starting dynamic subtest: pipe-D-HDMI-A-1-size-128 [220.522230] Dynamic subtest pipe-D-HDMI-A-1-size-128: SUCCESS (1.416s) [220.557933] Starting dynamic subtest: pipe-D-HDMI-A-1-size-256 [221.947279] Dynamic subtest pipe-D-HDMI-A-1-size-256: SUCCESS (1.400s) [222.022491] Subtest overlay: SUCCESS (17.430s) [222.129389] [060/133] (795s left) kms_sequence (queue-busy) [222.219377] Starting subtest: queue-busy [222.221228] Starting dynamic subtest: pipe-A-HDMI-A-1 [223.515427] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (1.294s) [223.525704] Starting dynamic subtest: pipe-B-HDMI-A-1 [224.786769] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (1.270s) [224.798331] Starting dynamic subtest: pipe-C-HDMI-A-1 [226.052546] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (1.264s) [226.061404] Starting dynamic subtest: pipe-D-HDMI-A-1 [227.310164] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (1.255s) [227.310892] Subtest queue-busy: SUCCESS (5.091s) [227.415792] [061/133] (790s left) kms_flip (single-buffer-flip-vs-dpms-off-vs-modeset) [227.506304] Starting subtest: single-buffer-flip-vs-dpms-off-vs-modeset [227.508527] Starting dynamic subtest: A-HDMI-A1 [228.204148] Dynamic subtest A-HDMI-A1: SUCCESS (0.695s) [228.213672] Starting dynamic subtest: B-HDMI-A1 [228.896024] Dynamic subtest B-HDMI-A1: SUCCESS (0.691s) [228.906188] Starting dynamic subtest: C-HDMI-A1 [229.506872] Dynamic subtest C-HDMI-A1: SUCCESS (0.608s) [229.514539] Starting dynamic subtest: D-HDMI-A1 [230.117731] Dynamic subtest D-HDMI-A1: SUCCESS (0.610s) [230.119851] Subtest single-buffer-flip-vs-dpms-off-vs-modeset: SUCCESS (2.614s) [230.241557] [062/133] (787s left) gem_flink_basic (double-flink) [230.280362] Starting subtest: double-flink [230.281092] Subtest double-flink: SUCCESS (0.000s) [230.371276] [063/133] (787s left) gem_ctx_isolation (dirty-switch) [230.412164] Starting subtest: dirty-switch [230.412848] Starting dynamic subtest: rcs0 [230.595233] Dynamic subtest rcs0: SUCCESS (0.175s) [230.602706] Starting dynamic subtest: bcs0 [230.807872] Dynamic subtest bcs0: SUCCESS (0.211s) [230.815115] Starting dynamic subtest: vcs0 [231.024497] Dynamic subtest vcs0: SUCCESS (0.215s) [231.032194] Starting dynamic subtest: vcs1 [231.233306] Dynamic subtest vcs1: SUCCESS (0.207s) [231.240490] Starting dynamic subtest: vecs0 [231.446664] Dynamic subtest vecs0: SUCCESS (0.212s) [231.447399] Subtest dirty-switch: SUCCESS (1.026s) [231.617976] [064/133] (786s left) kms_cursor_edge_walk (64x64-top-edge) [231.706432] Starting subtest: 64x64-top-edge [231.707154] Starting dynamic subtest: pipe-A-HDMI-A-1 [233.450994] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (1.744s) [233.460194] Starting dynamic subtest: pipe-D-HDMI-A-1 [235.114701] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (1.660s) [235.115383] Subtest 64x64-top-edge: SUCCESS (3.409s) [235.230002] [065/133] (782s left) kms_ccs (random-ccs-data-y-tiled-gen12-mc-ccs) [235.325456] Starting subtest: random-ccs-data-y-tiled-gen12-mc-ccs [235.327270] Starting dynamic subtest: pipe-A-HDMI-A-1 [235.334828] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.000s) [235.342669] Starting dynamic subtest: pipe-B-HDMI-A-1 [235.350107] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.000s) [235.357598] Starting dynamic subtest: pipe-C-HDMI-A-1 [235.364992] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.000s) [235.372599] Starting dynamic subtest: pipe-D-HDMI-A-1 [235.380022] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.000s) [235.381362] Subtest random-ccs-data-y-tiled-gen12-mc-ccs: SKIP (0.008s) [235.572528] [066/133] (782s left) gem_eio (hibernate) [235.617250] Starting subtest: hibernate [248.768069] Subtest hibernate: SUCCESS (13.150s) [257.951523] [067/133] (769s left) kms_flip (2x-blocking-absolute-wf_vblank-interruptible) [258.053049] Starting subtest: 2x-blocking-absolute-wf_vblank-interruptible [258.062540] Subtest 2x-blocking-absolute-wf_vblank-interruptible: SKIP (0.009s) [258.122578] [068/133] (769s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite) [258.210121] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite [258.211463] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s) [258.286142] [069/133] (769s left) kms_busy (extended-modeset-hang-newfb-with-reset) [258.385181] Starting subtest: extended-modeset-hang-newfb-with-reset [258.386888] Starting dynamic subtest: pipe-A [261.226614] Dynamic subtest pipe-A: SUCCESS (2.839s) [261.236852] Starting dynamic subtest: pipe-D [264.096883] Dynamic subtest pipe-D: SUCCESS (2.867s) [264.097578] Subtest extended-modeset-hang-newfb-with-reset: SUCCESS (5.712s) [264.250049] [070/133] (763s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-16bpp-ytile-upscaling) [264.339844] Starting subtest: flip-64bpp-ytile-to-16bpp-ytile-upscaling [264.341998] Starting dynamic subtest: pipe-A-valid-mode [265.109371] Dynamic subtest pipe-A-valid-mode: SUCCESS (0.767s) [265.110110] Subtest flip-64bpp-ytile-to-16bpp-ytile-upscaling: SUCCESS (0.769s) [265.263307] [071/133] (762s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-render) [265.353325] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-render [266.570395] Subtest fbc-1p-primscrn-cur-indfb-draw-render: SUCCESS (1.217s) [266.696737] [072/133] (760s left) sysfs_preempt_timeout (invalid) [266.734259] Starting subtest: invalid [266.734946] Starting dynamic subtest: vecs0 [266.735640] Dynamic subtest vecs0: SUCCESS (0.000s) [266.743577] Starting dynamic subtest: vcs0 [266.744270] Dynamic subtest vcs0: SUCCESS (0.000s) [266.751787] Starting dynamic subtest: bcs0 [266.752600] Dynamic subtest bcs0: SUCCESS (0.000s) [266.759973] Starting dynamic subtest: rcs0 [266.760660] Dynamic subtest rcs0: SUCCESS (0.000s) [266.767748] Starting dynamic subtest: vcs1 [266.768421] Dynamic subtest vcs1: SUCCESS (0.000s) [266.769111] Subtest invalid: SUCCESS (0.007s) [266.838055] [073/133] (760s left) gem_exec_big (single) [266.875762] Starting subtest: single [271.182655] Subtest single: FAIL (4.290s) [271.294949] [074/133] (756s left) kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-rc-ccs-cc) [271.416850] Starting subtest: crc-sprite-planes-basic-y-tiled-gen12-rc-ccs-cc [271.417606] Starting dynamic subtest: pipe-A-HDMI-A-1 [272.093161] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.672s) [272.112671] Starting dynamic subtest: pipe-B-HDMI-A-1 [272.627612] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.529s) [272.644383] Starting dynamic subtest: pipe-C-HDMI-A-1 [273.161879] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.529s) [273.178380] Starting dynamic subtest: pipe-D-HDMI-A-1 [273.695203] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.528s) [273.696246] Subtest crc-sprite-planes-basic-y-tiled-gen12-rc-ccs-cc: SUCCESS (2.276s) [273.882426] [075/133] (753s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-0) [273.982521] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-0 [273.983843] Subtest 4-tiled-max-hw-stride-32bpp-rotate-0: SKIP (0.000s) [274.063667] [076/133] (753s left) kms_chamelium_hpd (dp-hpd-storm) [274.199804] Subtest dp-hpd-storm: SKIP (0.000s) [274.294465] [077/133] (753s left) i915_query (query-topology-kernel-writes) [274.331341] Starting subtest: query-topology-kernel-writes [274.332151] Subtest query-topology-kernel-writes: SUCCESS (0.000s) [274.392187] [078/133] (753s left) kms_plane (pixel-format-y-tiled-modifier-source-clamping) [274.477551] Starting subtest: pixel-format-y-tiled-modifier-source-clamping [274.491962] Starting dynamic subtest: pipe-A-plane-0 [275.000524] Dynamic subtest pipe-A-plane-0: SUCCESS (0.508s) [275.014602] Starting dynamic subtest: pipe-A-plane-3 [275.433838] Dynamic subtest pipe-A-plane-3: SUCCESS (0.431s) [275.452419] Starting dynamic subtest: pipe-A-plane-5 [275.767292] Dynamic subtest pipe-A-plane-5: SUCCESS (0.330s) [275.921306] Starting dynamic subtest: pipe-B-plane-0 [276.388837] Dynamic subtest pipe-B-plane-0: SUCCESS (0.475s) [276.405995] Starting dynamic subtest: pipe-B-plane-3 [276.830560] Dynamic subtest pipe-B-plane-3: SUCCESS (0.439s) [276.848607] Starting dynamic subtest: pipe-B-plane-5 [277.163934] Dynamic subtest pipe-B-plane-5: SUCCESS (0.331s) [277.245237] Subtest pixel-format-y-tiled-modifier-source-clamping: SUCCESS (2.768s) [277.382868] [079/133] (750s left) gem_exec_params (invalid-bsd2-flag-on-blt) [277.422928] Starting subtest: invalid-bsd2-flag-on-blt [277.423644] Subtest invalid-bsd2-flag-on-blt: SUCCESS (0.000s) [277.513723] [080/133] (750s left) sw_sync (sync_busy_fork) [277.552707] Starting subtest: sync_busy_fork [278.574604] Subtest sync_busy_fork: SUCCESS (1.013s) [278.632112] [081/133] (749s left) syncobj_timeline (invalid-multi-wait-unsubmitted-submitted-signaled) [278.674214] Starting subtest: invalid-multi-wait-unsubmitted-submitted-signaled [278.674894] Subtest invalid-multi-wait-unsubmitted-submitted-signaled: SUCCESS (0.001s) [278.730308] [082/133] (749s left) kms_chamelium_frames (hdmi-crc-fast) [278.874190] Subtest hdmi-crc-fast: SKIP (0.000s) [278.967657] [083/133] (748s left) gem_flink_basic (flink-lifetime) [279.006245] Starting subtest: flink-lifetime [279.006980] Subtest flink-lifetime: SUCCESS (0.001s) [279.109361] [084/133] (748s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-mmap-gtt) [279.197994] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-mmap-gtt [279.199326] Subtest fbc-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s) [279.297963] [085/133] (748s left) kms_prop_blob (basic) [279.331892] Starting subtest: basic [279.332602] Subtest basic: SUCCESS (0.000s) [279.385348] [086/133] (748s left) syncobj_timeline (etime-multi-wait-all-for-submit-unsubmitted-signaled) [279.418761] Starting subtest: etime-multi-wait-all-for-submit-unsubmitted-signaled [279.528247] Subtest etime-multi-wait-all-for-submit-unsubmitted-signaled: SUCCESS (0.109s) [279.596179] [087/133] (748s left) perf (blocking-parameterized) [279.681901] Starting subtest: blocking-parameterized [299.736287] Subtest blocking-parameterized: SUCCESS (20.016s) [299.800217] [088/133] (728s left) syncobj_timeline (etime-multi-wait-all-submitted-signaled) [299.842305] Starting subtest: etime-multi-wait-all-submitted-signaled [299.944082] Subtest etime-multi-wait-all-submitted-signaled: SUCCESS (0.101s) [300.017330] [089/133] (728s left) gem_exec_fence (submit-chain) [300.183375] Starting subtest: submit-chain [300.194218] Subtest submit-chain: SUCCESS (0.013s) [300.679408] [FACT gem_exec_fence (submit-chain)] new: kernel.kmod_is_loaded.vgem: true [300.684184] [090/133] (727s left) gem_exec_params (mmapped) [300.721148] Starting subtest: mmapped [300.721837] Subtest mmapped: SUCCESS (0.001s) [300.829522] [091/133] (727s left) kms_big_fb (x-tiled-32bpp-rotate-180) [300.922924] Starting subtest: x-tiled-32bpp-rotate-180 [302.130799] Subtest x-tiled-32bpp-rotate-180: SUCCESS (1.207s) [302.250156] [092/133] (726s left) sw_sync (sync_expired_merge) [302.282603] Starting subtest: sync_expired_merge [303.365318] Subtest sync_expired_merge: SUCCESS (1.074s) [303.412054] [093/133] (724s left) prime_vgem (basic-fence-mmap) [303.452410] Starting subtest: basic-fence-mmap [303.474175] Subtest basic-fence-mmap: SUCCESS (0.022s) [303.577840] [094/133] (724s left) gem_ctx_shared (disjoint-timelines) [303.618658] Starting subtest: disjoint-timelines [303.623153] Subtest disjoint-timelines: SUCCESS (0.004s) [303.847371] [095/133] (724s left) kms_psr (psr-dpms) [303.934960] Subtest psr-dpms: SKIP (0.000s) [303.979913] [096/133] (724s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-msflip-blt) [304.073297] Starting subtest: fbcpsr-1p-primscrn-indfb-msflip-blt [304.074628] Subtest fbcpsr-1p-primscrn-indfb-msflip-blt: SKIP (0.000s) [304.170602] [097/133] (724s left) gem_softpin (allocator-nopin) [304.207585] Starting subtest: allocator-nopin [304.285608] Subtest allocator-nopin: SUCCESS (0.078s) [304.396407] [098/133] (724s left) kms_flip_scaled_crc (flip-32bpp-linear-to-64bpp-linear-downscaling) [304.481618] Starting subtest: flip-32bpp-linear-to-64bpp-linear-downscaling [304.483453] Starting dynamic subtest: pipe-A-valid-mode [306.325653] Dynamic subtest pipe-A-valid-mode: SUCCESS (1.842s) [306.326470] Subtest flip-32bpp-linear-to-64bpp-linear-downscaling: SUCCESS (1.844s) [306.494460] [099/133] (722s left) gem_exec_flush (basic-wb-pro-default) [306.539243] Starting subtest: basic-wb-pro-default [311.973243] Subtest basic-wb-pro-default: SUCCESS (5.435s) [312.187172] [100/133] (716s left) kms_psr2_sf (fbc-psr2-plane-move-sf-dmg-area) [312.275586] Subtest fbc-psr2-plane-move-sf-dmg-area: SKIP (0.000s) [312.320118] [101/133] (716s left) syncobj_timeline (single-wait-available-submitted) [312.354089] Starting subtest: single-wait-available-submitted [312.354783] Subtest single-wait-available-submitted: SUCCESS (0.000s) [312.416866] [102/133] (716s left) gem_render_copy (y-tiled-mc-ccs-to-yf-tiled-ccs) [312.457354] Starting subtest: y-tiled-mc-ccs-to-yf-tiled-ccs [312.458060] Starting dynamic subtest: smem [312.538041] Dynamic subtest smem: SUCCESS (0.080s) [312.538756] Subtest y-tiled-mc-ccs-to-yf-tiled-ccs: SUCCESS (0.081s) [312.722527] [103/133] (716s left) kms_frontbuffer_tracking (psr-rgb101010-draw-pwrite) [312.811169] Starting subtest: psr-rgb101010-draw-pwrite [312.812539] Subtest psr-rgb101010-draw-pwrite: SKIP (0.000s) [312.909550] [104/133] (715s left) perf (gen8-unprivileged-single-ctx-counters) [313.009357] Starting subtest: gen8-unprivileged-single-ctx-counters [313.010748] Subtest gen8-unprivileged-single-ctx-counters: SKIP (0.000s) [313.047989] [105/133] (715s left) api_intel_allocator (standalone) [313.081362] Starting subtest: standalone [313.097291] Subtest standalone: SUCCESS (0.017s) [313.160197] [106/133] (715s left) kms_getfb (getfb-handle-closed) [313.245435] Starting subtest: getfb-handle-closed [313.246169] Subtest getfb-handle-closed: SUCCESS (0.000s) [313.336935] [107/133] (715s left) perf (mi-rpc) [313.409537] Starting subtest: mi-rpc [313.410962] Subtest mi-rpc: SKIP (0.000s) [313.447042] [108/133] (715s left) kms_async_flips (async-flip-dpms) [313.532408] Starting subtest: async-flip-dpms [313.657279] Starting dynamic subtest: pipe-A-HDMI-A-1 [316.104439] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (2.448s) [316.274601] Starting dynamic subtest: pipe-B-HDMI-A-1 [318.761146] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (2.495s) [318.913184] Starting dynamic subtest: pipe-C-HDMI-A-1 [321.306080] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (2.401s) [321.461161] Starting dynamic subtest: pipe-D-HDMI-A-1 [323.943088] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (2.493s) [323.947361] Subtest async-flip-dpms: SUCCESS (10.415s) [324.208388] [109/133] (704s left) kms_big_fb (y-tiled-64bpp-rotate-180) [324.309509] Starting subtest: y-tiled-64bpp-rotate-180 [325.736809] Subtest y-tiled-64bpp-rotate-180: SUCCESS (1.428s) [325.861088] [110/133] (703s left) gem_close_race (multigpu-basic-process) [325.904671] Starting subtest: multigpu-basic-process [325.906021] Subtest multigpu-basic-process: SKIP (0.000s) [326.083331] [111/133] (703s left) kms_cursor_crc (cursor-offscreen-32x10) [326.171503] Starting subtest: cursor-offscreen-32x10 [326.224518] Subtest cursor-offscreen-32x10: SKIP (0.051s) [326.329993] [112/133] (702s left) gem_exec_flush (basic-wb-rw-default) [326.372260] Starting subtest: basic-wb-rw-default [331.797655] Subtest basic-wb-rw-default: SUCCESS (5.426s) [332.005903] [113/133] (697s left) dmabuf_sync_file (export-before-signal) [332.046903] Starting subtest: export-before-signal [332.047609] Subtest export-before-signal: SUCCESS (0.001s) [332.100373] [114/133] (697s left) gem_exec_schedule (preempt-queue-contexts-chain) [332.145453] Starting subtest: preempt-queue-contexts-chain [332.146160] Starting dynamic subtest: rcs0 [332.503916] Dynamic subtest rcs0: SUCCESS (0.349s) [332.514098] Starting dynamic subtest: bcs0 [332.855182] Dynamic subtest bcs0: SUCCESS (0.350s) [332.866225] Starting dynamic subtest: vcs0 [333.215086] Dynamic subtest vcs0: SUCCESS (0.359s) [333.227025] Starting dynamic subtest: vcs1 [333.571488] Dynamic subtest vcs1: SUCCESS (0.355s) [333.580898] Starting dynamic subtest: vecs0 [333.935891] Dynamic subtest vecs0: SUCCESS (0.363s) [333.936672] Subtest preempt-queue-contexts-chain: SUCCESS (1.782s) [334.225324] [115/133] (695s left) perf_pmu (semaphore-wait) [334.262014] Starting subtest: semaphore-wait [334.262710] Starting dynamic subtest: rcs0 [334.780880] Dynamic subtest rcs0: SUCCESS (0.509s) [334.792574] Starting dynamic subtest: bcs0 [335.293273] Dynamic subtest bcs0: SUCCESS (0.510s) [335.304713] Starting dynamic subtest: vcs0 [335.804644] Dynamic subtest vcs0: SUCCESS (0.509s) [335.815862] Starting dynamic subtest: vcs1 [336.316724] Dynamic subtest vcs1: SUCCESS (0.510s) [336.327278] Starting dynamic subtest: vecs0 [336.830014] Dynamic subtest vecs0: SUCCESS (0.511s) [336.830746] Subtest semaphore-wait: SUCCESS (2.560s) [336.923073] [116/133] (692s left) gem_basic (multigpu-create-close) [336.957457] Starting subtest: multigpu-create-close [336.958828] Subtest multigpu-create-close: SKIP (0.000s) [337.017177] [117/133] (692s left) kms_vblank (query-idle) [337.104436] Starting subtest: query-idle [337.106241] Starting dynamic subtest: pipe-A-HDMI-A-1 [338.282196] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (1.175s) [338.295715] Starting dynamic subtest: pipe-D-HDMI-A-1 [339.446785] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (1.159s) [339.447548] Subtest query-idle: SUCCESS (2.343s) [339.607630] [118/133] (689s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt) [339.702176] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt [339.703541] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s) [339.798159] [119/133] (689s left) syncobj_timeline (reset-during-wait-for-submit) [339.831852] Starting subtest: reset-during-wait-for-submit [339.934625] Subtest reset-during-wait-for-submit: SUCCESS (0.102s) [340.013110] [120/133] (689s left) i915_suspend (basic-s3-without-i915) [340.045539] Starting subtest: basic-s3-without-i915