[57.207262] Initializing watchdogs
[57.207311]   /dev/watchdog0
[57.221717] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics]
[57.226083] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[57.228294] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[57.232105] [001/132] (960s left) gem_exec_schedule (independent)
[57.331427] Starting subtest: independent
[57.334305] Starting dynamic subtest: rcs0
[58.906087] Dynamic subtest rcs0: SUCCESS (1.579s)
[58.916981] Starting dynamic subtest: vcs0
[60.921905] Dynamic subtest vcs0: SUCCESS (2.014s)
[60.931750] Starting dynamic subtest: vcs1
[62.983816] Dynamic subtest vcs1: SUCCESS (2.061s)
[62.993143] Starting dynamic subtest: vecs0
[64.971375] Dynamic subtest vecs0: SUCCESS (1.987s)
[64.981290] Starting dynamic subtest: ccs0
[66.905048] Dynamic subtest ccs0: SUCCESS (1.933s)
[66.907631] Subtest independent: SUCCESS (9.580s)
[67.256088] [002/132] (950s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-shrfb-msflip-blt)
[67.391675] Starting subtest: fbc-2p-scndscrn-shrfb-msflip-blt
[67.396075] Subtest fbc-2p-scndscrn-shrfb-msflip-blt: SKIP (0.000s)
[67.615930] [003/132] (950s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-render)
[67.758927] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-render
[67.763197] Subtest fbc-2p-scndscrn-cur-indfb-draw-render: SKIP (0.000s)
[67.965980] [004/132] (949s left) syncobj_timeline (invalid-signal-one-illegal-handle)
[68.077882] Starting subtest: invalid-signal-one-illegal-handle
[68.080319] Subtest invalid-signal-one-illegal-handle: SUCCESS (0.000s)
[68.190212] [005/132] (949s left) gem_softpin (32b-excludes-last-page)
[68.259058] Starting subtest: 32b-excludes-last-page
[68.264284] Subtest 32b-excludes-last-page: SUCCESS (0.005s)
[68.423956] [006/132] (949s left) gem_mmap_gtt (basic-copy)
[68.476064] Subtest basic-copy: SKIP (0.000s)
[68.530033] [007/132] (949s left) kms_content_protection (atomic-dpms-hdcp14)
[68.671811] Starting subtest: atomic-dpms-hdcp14
[68.676240] Subtest atomic-dpms-hdcp14: SKIP (0.000s)
[68.824832] [008/132] (949s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-render)
[68.937129] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-render
[75.795308] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-render: SUCCESS (6.861s)
[75.968687] [009/132] (942s left) gem_mmap_gtt (coherency)
[76.036413] Subtest coherency: SKIP (0.000s)
[76.093108] [010/132] (942s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-32bpp-xtile-upscaling)
[76.186086] Starting subtest: flip-64bpp-xtile-to-32bpp-xtile-upscaling
[76.188307] Starting dynamic subtest: pipe-A-default-mode
[78.904448] Dynamic subtest pipe-A-default-mode: SUCCESS (2.718s)
[78.906727] Subtest flip-64bpp-xtile-to-32bpp-xtile-upscaling: SUCCESS (2.720s)
[79.764311] [011/132] (938s left) kms_cursor_crc (cursor-offscreen-512x170)
[80.063470] Starting subtest: cursor-offscreen-512x170
[80.067687] Subtest cursor-offscreen-512x170: SKIP (0.001s)
[80.244025] [012/132] (937s left) perf_pmu (busy-double-start)
[80.284009] Starting subtest: busy-double-start
[80.286362] Starting dynamic subtest: rcs0
[83.925637] Dynamic subtest rcs0: FAIL (3.589s)
[83.933642] Starting dynamic subtest: bcs0
[87.448258] Dynamic subtest bcs0: SUCCESS (3.574s)
[87.458732] Starting dynamic subtest: vcs0
[91.455257] Dynamic subtest vcs0: SUCCESS (4.005s)
[91.464767] Starting dynamic subtest: vcs1
[95.481086] Dynamic subtest vcs1: SUCCESS (4.025s)
[95.491967] Starting dynamic subtest: vecs0
[99.423794] Dynamic subtest vecs0: SUCCESS (3.942s)
[99.433888] Starting dynamic subtest: ccs0
[103.059862] Dynamic subtest ccs0: FAIL (3.566s)
[103.061786] Subtest busy-double-start: FAIL (22.706s)
[103.136076] [013/132] (915s left) kms_frontbuffer_tracking (fbc-rgb565-draw-pwrite)
[103.245195] Starting subtest: fbc-rgb565-draw-pwrite
[107.880701] Subtest fbc-rgb565-draw-pwrite: SUCCESS (4.641s)
[109.077654] [014/132] (909s left) gem_tiled_pread_basic
[109.200254] [015/132] (909s left) kms_psr (fbc-psr2-cursor-plane-move)
[109.299696] Starting subtest: fbc-psr2-cursor-plane-move
[109.301615] Starting dynamic subtest: eDP-1
[109.305705] Dynamic subtest eDP-1: SKIP (0.000s)
[109.309827] Subtest fbc-psr2-cursor-plane-move: SKIP (0.001s)
[109.393881] [016/132] (908s left) gem_render_copy (y-tiled-ccs-to-linear)
[109.462734] Starting subtest: y-tiled-ccs-to-linear
[109.467230] Subtest y-tiled-ccs-to-linear: SKIP (0.000s)
[109.665910] [017/132] (908s left) kms_color (ctm-0-25)
[109.771612] Starting subtest: ctm-0-25
[109.773504] Starting dynamic subtest: pipe-A-eDP-1
[113.163069] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.391s)
[113.172346] Starting dynamic subtest: pipe-B-eDP-1
[117.285474] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.123s)
[117.294787] Starting dynamic subtest: pipe-C-eDP-1
[121.272063] Dynamic subtest pipe-C-eDP-1: SUCCESS (3.984s)
[121.281514] Starting dynamic subtest: pipe-D-eDP-1
[125.248166] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.977s)
[125.250584] Subtest ctm-0-25: SUCCESS (15.477s)
[126.096598] [018/132] (892s left) gem_exec_fence (syncobj-timeline-multiple-ext-nodes)
[126.650228] Starting subtest: syncobj-timeline-multiple-ext-nodes
[126.652852] Subtest syncobj-timeline-multiple-ext-nodes: SUCCESS (0.003s)
[128.025983] [FACT gem_exec_fence (syncobj-timeline-multiple-ext-nodes)] new: kernel.kmod_is_loaded.vgem: true
[128.029216] [019/132] (890s left) kms_flip (2x-flip-vs-wf_vblank-interruptible)
[128.135070] Starting subtest: 2x-flip-vs-wf_vblank-interruptible
[128.147443] Subtest 2x-flip-vs-wf_vblank-interruptible: SKIP (0.011s)
[128.252268] [020/132] (890s left) gem_mmap_gtt (fault-concurrent-y)
[128.306335] Subtest fault-concurrent-Y: SKIP (0.000s)
[128.386496] [021/132] (890s left) syncobj_timeline (reset-signaled)
[128.446363] Starting subtest: reset-signaled
[128.448711] Subtest reset-signaled: SUCCESS (0.000s)
[128.551915] [022/132] (890s left) kms_lease (simple-lease)
[128.642118] Starting subtest: simple-lease
[128.644446] Starting dynamic subtest: pipe-A-eDP-1
[129.172569] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.530s)
[129.181213] Starting dynamic subtest: pipe-B-eDP-1
[130.619198] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.445s)
[130.626919] Starting dynamic subtest: pipe-C-eDP-1
[132.017031] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.397s)
[132.025851] Starting dynamic subtest: pipe-D-eDP-1
[133.430493] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.411s)
[133.432755] Subtest simple-lease: SUCCESS (4.788s)
[134.253422] [023/132] (884s left) gem_exec_whisper (basic-queues-priority-all)
[134.323618] Starting subtest: basic-queues-priority-all
[156.185763] Subtest basic-queues-priority-all: SUCCESS (21.859s)
[156.394267] [024/132] (862s left) gem_exec_balancer (parallel-ordering)
[156.665972] Starting subtest: parallel-ordering
[157.616421] Subtest parallel-ordering: SUCCESS (0.953s)
[157.790622] [025/132] (860s left) gem_fenced_exec_thrash (too-many-fences)
[157.862593] Subtest too-many-fences: SKIP (0.000s)
[157.934155] [026/132] (860s left) kms_chamelium_frames (dp-crc-single)
[158.317201] Subtest dp-crc-single: SKIP (0.000s)
[159.132462] [027/132] (859s left) kms_big_fb (linear-16bpp-rotate-90)
[159.242993] Starting subtest: linear-16bpp-rotate-90
[159.262579] Subtest linear-16bpp-rotate-90: SKIP (0.019s)
[159.432294] [028/132] (859s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-180-hflip)
[159.545419] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-180-hflip
[159.549671] Subtest y-tiled-max-hw-stride-64bpp-rotate-180-hflip: SKIP (0.000s)
[159.684061] [029/132] (859s left) api_intel_bb (crc32)
[159.743635] Starting subtest: crc32
[159.745632] Starting dynamic subtest: rcs0-smem0
[160.031236] Dynamic subtest rcs0-smem0: SUCCESS (0.289s)
[160.042249] Starting dynamic subtest: bcs0-smem0
[160.334319] Dynamic subtest bcs0-smem0: SUCCESS (0.301s)
[160.344622] Starting dynamic subtest: vcs0-smem0
[160.653785] Dynamic subtest vcs0-smem0: SUCCESS (0.318s)
[160.665392] Starting dynamic subtest: vcs1-smem0
[160.973387] Dynamic subtest vcs1-smem0: SUCCESS (0.316s)
[160.984672] Starting dynamic subtest: vecs0-smem0
[161.309218] Dynamic subtest vecs0-smem0: SUCCESS (0.334s)
[161.320575] Starting dynamic subtest: ccs0-smem0
[161.624554] Dynamic subtest ccs0-smem0: SUCCESS (0.314s)
[161.627324] Subtest crc32: SUCCESS (1.883s)
[161.786641] [030/132] (857s left) kms_psr (fbc-pr-sprite-plane-onoff)
[161.878920] Starting subtest: fbc-pr-sprite-plane-onoff
[161.882959] Subtest fbc-pr-sprite-plane-onoff: SKIP (0.000s)
[161.974294] [031/132] (856s left) gem_eio (wait-1us)
[162.185795] Starting subtest: wait-1us
[162.520312] Subtest wait-1us: SUCCESS (0.334s)
[162.712223] [032/132] (856s left) kms_feature_discovery (chamelium)
[162.813488] Starting subtest: chamelium
[162.816818] Subtest chamelium: SKIP (0.000s)
[162.912171] [033/132] (856s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-mmap-gtt)
[163.013121] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-mmap-gtt
[163.016655] Subtest psr-1p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[163.143265] [034/132] (855s left) kms_flip (single-buffer-flip-vs-dpms-off-vs-modeset)
[163.240227] Starting subtest: single-buffer-flip-vs-dpms-off-vs-modeset
[163.242211] Starting dynamic subtest: A-eDP1
[166.863973] Dynamic subtest A-eDP1: SUCCESS (3.622s)
[166.872761] Starting dynamic subtest: B-eDP1
[170.083472] Dynamic subtest B-eDP1: SUCCESS (3.219s)
[170.093380] Starting dynamic subtest: C-eDP1
[173.197059] Dynamic subtest C-eDP1: SUCCESS (3.112s)
[173.206691] Starting dynamic subtest: D-eDP1
[176.310533] Dynamic subtest D-eDP1: SUCCESS (3.114s)
[176.312948] Subtest single-buffer-flip-vs-dpms-off-vs-modeset: SUCCESS (13.072s)
[177.127255] [035/132] (841s left) i915_pciid
[177.325344] [036/132] (841s left) kms_plane_scaling (plane-scaler-unity-scaling-with-modifiers)
[177.428878] Starting subtest: plane-scaler-unity-scaling-with-modifiers
[177.431180] Starting dynamic subtest: pipe-A
[177.798912] Dynamic subtest pipe-A: SUCCESS (0.372s)
[177.813714] Starting dynamic subtest: pipe-B
[179.191090] Dynamic subtest pipe-B: SUCCESS (1.391s)
[179.202224] Starting dynamic subtest: pipe-C
[180.630657] Dynamic subtest pipe-C: SUCCESS (1.439s)
[180.645212] Starting dynamic subtest: pipe-D
[182.066359] Dynamic subtest pipe-D: SUCCESS (1.434s)
[182.068629] Subtest plane-scaler-unity-scaling-with-modifiers: SUCCESS (4.641s)
[183.249516] [037/132] (835s left) gem_exec_flush (basic-wb-ro-before-default)
[183.326647] Starting subtest: basic-wb-ro-before-default
[188.812494] Subtest basic-wb-ro-before-default: SUCCESS (5.451s)
[188.988446] [038/132] (830s left) kms_big_fb (4-tiled-8bpp-rotate-180)
[189.098490] Starting subtest: 4-tiled-8bpp-rotate-180
[190.337673] Subtest 4-tiled-8bpp-rotate-180: SUCCESS (1.240s)
[190.507593] [039/132] (828s left) kms_pipe_stress (stress-xrgb8888-untiled)
[190.609091] Starting subtest: stress-xrgb8888-untiled
[196.476922] Subtest stress-xrgb8888-untiled: SUCCESS (5.868s)
[196.522400] [040/132] (822s left) gem_exec_reloc (basic-cpu-wc-active)
[196.586699] Subtest basic-cpu-wc-active: SKIP (0.000s)
[196.672366] [041/132] (822s left) gem_pxp (verify-pxp-key-change-after-suspend-resume)
[196.799812] Starting subtest: verify-pxp-key-change-after-suspend-resume
[207.685108] Subtest verify-pxp-key-change-after-suspend-resume: SUCCESS (10.886s)
[207.850633] [042/132] (811s left) kms_rotation_crc (primary-yf-tiled-reflect-x-90)
[207.958256] Starting subtest: primary-yf-tiled-reflect-x-90
[207.962587] Subtest primary-yf-tiled-reflect-x-90: SKIP (0.001s)
[208.052400] [043/132] (811s left) api_intel_bb (blit-noreloc-keep-cache)
[208.115912] Starting subtest: blit-noreloc-keep-cache
[208.124182] Subtest blit-noreloc-keep-cache: SUCCESS (0.010s)
[208.283037] [044/132] (811s left) kms_pm_backlight (fade-with-suspend)
[208.374132] Starting subtest: fade-with-suspend
[224.365594] Starting dynamic subtest: eDP-1
[227.024386] Dynamic subtest eDP-1: SUCCESS (2.664s)
[227.026737] Subtest fade-with-suspend: SUCCESS (3.900s)
[227.864053] [045/132] (791s left) kms_addfb_basic (small-bo)
[227.960630] Starting subtest: small-bo
[227.962921] Subtest small-bo: SUCCESS (0.000s)
[228.083319] [046/132] (791s left) gem_userptr_blits (mmap-offset-banned)
[228.145420] Starting subtest: mmap-offset-banned
[228.147854] Starting dynamic subtest: wb
[228.150098] Dynamic subtest wb: SUCCESS (0.000s)
[228.161093] Starting dynamic subtest: wc
[228.162873] Dynamic subtest wc: SUCCESS (0.000s)
[228.171579] Starting dynamic subtest: uc
[228.173505] Dynamic subtest uc: SUCCESS (0.000s)
[228.175436] Subtest mmap-offset-banned: SUCCESS (0.003s)
[228.310820] [047/132] (791s left) kms_invalid_mode (zero-vdisplay)
[228.396212] Starting subtest: zero-vdisplay
[228.398473] Starting dynamic subtest: pipe-A-eDP-1
[228.695895] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.299s)
[228.705504] Starting dynamic subtest: pipe-B-eDP-1
[228.707398] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[228.715675] Starting dynamic subtest: pipe-C-eDP-1
[228.717745] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[228.726787] Starting dynamic subtest: pipe-D-eDP-1
[228.728961] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[228.731091] Subtest zero-vdisplay: SUCCESS (0.306s)
[229.594121] [048/132] (790s left) kms_frontbuffer_tracking (psr-rgb101010-draw-pwrite)
[229.696640] Starting subtest: psr-rgb101010-draw-pwrite
[237.340269] Subtest psr-rgb101010-draw-pwrite: SUCCESS (7.643s)
[237.478014] [049/132] (782s left) kms_ccs (crc-sprite-planes-basic-4-tiled-dg2-rc-ccs-cc)
[237.584423] Starting subtest: crc-sprite-planes-basic-4-tiled-dg2-rc-ccs-cc
[237.586331] Starting dynamic subtest: pipe-A-eDP-1
[237.646097] Dynamic subtest pipe-A-eDP-1: SKIP (0.002s)
[237.656022] Starting dynamic subtest: pipe-B-eDP-1
[237.710476] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[237.719859] Starting dynamic subtest: pipe-C-eDP-1
[237.774430] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[237.783188] Starting dynamic subtest: pipe-D-eDP-1
[237.836748] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[237.841002] Subtest crc-sprite-planes-basic-4-tiled-dg2-rc-ccs-cc: SKIP (0.011s)
[239.867138] [050/132] (779s left) kms_cursor_crc (cursor-sliding-max-size)
[240.157679] Starting subtest: cursor-sliding-max-size
[240.164162] Subtest cursor-sliding-max-size: SKIP (0.000s)
[240.310872] [051/132] (779s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-pwrite)
[240.407332] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-pwrite
[240.411564] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[240.530624] [052/132] (779s left) syncobj_timeline (etime-multi-wait-for-submit-unsubmitted-submitted)
[240.592309] Starting subtest: etime-multi-wait-for-submit-unsubmitted-submitted
[240.697693] Subtest etime-multi-wait-for-submit-unsubmitted-submitted: SUCCESS (0.103s)
[240.799577] [053/132] (779s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-move)
[240.909042] Starting subtest: psr-2p-scndscrn-cur-indfb-move
[240.913473] Subtest psr-2p-scndscrn-cur-indfb-move: SKIP (0.000s)
[241.061516] [054/132] (778s left) kms_ccs (ccs-on-another-bo-y-tiled-gen12-rc-ccs)
[241.162145] Starting subtest: ccs-on-another-bo-y-tiled-gen12-rc-ccs
[241.164382] Starting dynamic subtest: pipe-A-eDP-1
[241.187312] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[241.199242] Starting dynamic subtest: pipe-B-eDP-1
[241.220358] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[241.230227] Starting dynamic subtest: pipe-C-eDP-1
[241.252222] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[241.261413] Starting dynamic subtest: pipe-D-eDP-1
[241.283148] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[241.287593] Subtest ccs-on-another-bo-y-tiled-gen12-rc-ccs: SKIP (0.005s)
[243.345619] [055/132] (776s left) kms_big_fb (x-tiled-16bpp-rotate-90)
[243.454006] Starting subtest: x-tiled-16bpp-rotate-90
[243.473649] Subtest x-tiled-16bpp-rotate-90: SKIP (0.019s)
[243.634301] [056/132] (776s left) kms_plane (plane-panning-top-left)
[243.734712] Starting subtest: plane-panning-top-left
[243.737011] Starting dynamic subtest: pipe-A
[245.388775] Dynamic subtest pipe-A: SUCCESS (1.653s)
[245.399400] Starting dynamic subtest: pipe-B
[247.755550] Dynamic subtest pipe-B: SUCCESS (2.365s)
[247.758046] Subtest plane-panning-top-left: SUCCESS (4.022s)
[248.655593] [057/132] (771s left) kms_getfb (getfb-handle-zero)
[248.756089] Starting subtest: getfb-handle-zero
[248.758350] Subtest getfb-handle-zero: SUCCESS (0.000s)
[248.895092] [058/132] (771s left) kms_flip (dpms-vs-vblank-race-interruptible)
[249.000599] Starting subtest: dpms-vs-vblank-race-interruptible
[249.002884] Starting dynamic subtest: A-eDP1
[253.918115] Dynamic subtest A-eDP1: SUCCESS (4.915s)
[253.929989] Starting dynamic subtest: B-eDP1
[257.509698] Dynamic subtest B-eDP1: SUCCESS (3.587s)
[257.520227] Starting dynamic subtest: C-eDP1
[262.117155] Dynamic subtest C-eDP1: SUCCESS (4.606s)
[262.127284] Starting dynamic subtest: D-eDP1
[266.734056] Dynamic subtest D-eDP1: SUCCESS (4.617s)
[266.736351] Subtest dpms-vs-vblank-race-interruptible: SUCCESS (17.734s)
[267.628500] [059/132] (752s left) kms_addfb_basic (bad-pitch-256)
[267.681578] Starting subtest: bad-pitch-256
[267.683853] Subtest bad-pitch-256: SUCCESS (0.000s)
[267.835255] [060/132] (752s left) kms_ccs (crc-primary-rotation-180-4-tiled-mtl-rc-ccs-cc)
[267.933563] Starting subtest: crc-primary-rotation-180-4-tiled-mtl-rc-ccs-cc
[267.935855] Starting dynamic subtest: pipe-A-eDP-1
[268.814894] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.874s)
[268.826376] Starting dynamic subtest: pipe-B-eDP-1
[270.330858] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.514s)
[270.343110] Starting dynamic subtest: pipe-C-eDP-1
[271.866478] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.533s)
[271.883039] Starting dynamic subtest: pipe-D-eDP-1
[273.352181] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.483s)
[273.354099] Subtest crc-primary-rotation-180-4-tiled-mtl-rc-ccs-cc: SUCCESS (5.410s)
[274.558256] [061/132] (745s left) kms_frontbuffer_tracking (psr-2p-primscrn-indfb-plflip-blt)
[274.661224] Starting subtest: psr-2p-primscrn-indfb-plflip-blt
[274.665530] Subtest psr-2p-primscrn-indfb-plflip-blt: SKIP (0.000s)
[274.794609] [062/132] (745s left) vgem_basic (busy-fence)
[274.834741] Starting subtest: busy-fence
[274.836676] Subtest busy-fence: SUCCESS (0.000s)
[274.916629] [063/132] (745s left) gem_ctx_shared (detached-shared-gtt)
[274.982649] Starting subtest: detached-shared-gtt
[277.135149] Subtest detached-shared-gtt: SUCCESS (2.151s)
[277.682277] [064/132] (742s left) kms_atomic_interruptible (legacy-dpms)
[277.786629] Starting subtest: legacy-dpms
[277.788897] Starting dynamic subtest: pipe-A-eDP-1
[285.276646] Dynamic subtest pipe-A-eDP-1: SUCCESS (7.487s)
[285.278472] Subtest legacy-dpms: SUCCESS (7.489s)
[286.131274] [065/132] (734s left) kms_psr2_sf (fbc-psr2-overlay-plane-update-sf-dmg-area)
[291.163055] Starting subtest: fbc-psr2-overlay-plane-update-sf-dmg-area
[291.165393] Starting dynamic subtest: pipe-A-eDP-1
[291.968294] Dynamic subtest pipe-A-eDP-1: SKIP (0.802s)
[291.978620] Starting dynamic subtest: pipe-B-eDP-1
[293.092695] Dynamic subtest pipe-B-eDP-1: SKIP (1.123s)
[293.097211] Subtest fbc-psr2-overlay-plane-update-sf-dmg-area: SKIP (1.929s)
[294.299406] [066/132] (726s left) kms_cursor_legacy (torture-bo)
[294.436662] Starting subtest: torture-bo
[294.438881] Starting dynamic subtest: pipe-A
[300.236015] Dynamic subtest pipe-A: SUCCESS (5.797s)
[300.248621] Starting dynamic subtest: pipe-B
[306.658756] Dynamic subtest pipe-B: SUCCESS (6.419s)
[306.669409] Starting dynamic subtest: pipe-C
[313.999162] Dynamic subtest pipe-C: SUCCESS (7.337s)
[314.011727] Starting dynamic subtest: pipe-D
[321.141930] Dynamic subtest pipe-D: SUCCESS (7.140s)
[321.155749] Starting dynamic subtest: all-pipes
[326.947164] Dynamic subtest all-pipes: SUCCESS (5.802s)
[326.949864] Subtest torture-bo: SUCCESS (32.508s)
[327.133172] [067/132] (693s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-mmap-wc)
[327.227214] Starting subtest: fbcpsr-rgb565-draw-mmap-wc
[333.987149] Subtest fbcpsr-rgb565-draw-mmap-wc: SUCCESS (6.762s)
[334.151050] [068/132] (686s left) kms_frontbuffer_tracking (fbcpsr-shrfb-scaledprimary)
[334.253991] Starting subtest: fbcpsr-shrfb-scaledprimary
[340.043155] Subtest fbcpsr-shrfb-scaledprimary: SUCCESS (5.793s)
[340.227728] [069/132] (680s left) gem_ppgtt (shrink-vs-evict-pinned)
[340.291614] Starting subtest: shrink-vs-evict-pinned
[345.672799] Subtest shrink-vs-evict-pinned: SUCCESS (5.328s)
[345.747779] [070/132] (674s left) kms_flip (flip-vs-blocking-wf-vblank)
[345.859197] Starting subtest: flip-vs-blocking-wf-vblank
[345.861471] Starting dynamic subtest: A-eDP1
[354.786631] Dynamic subtest A-eDP1: SUCCESS (8.929s)
[354.797749] Starting dynamic subtest: B-eDP1
[363.718343] Dynamic subtest B-eDP1: SUCCESS (8.931s)
[363.728023] Starting dynamic subtest: C-eDP1
[372.683360] Dynamic subtest C-eDP1: SUCCESS (8.917s)
[372.693231] Starting dynamic subtest: D-eDP1
[381.616374] Dynamic subtest D-eDP1: SUCCESS (8.929s)
[381.618749] Subtest flip-vs-blocking-wf-vblank: SUCCESS (35.716s)
[382.821595] [071/132] (637s left) syncobj_timeline (wait-all-interrupted)
[382.888160] Starting subtest: wait-all-interrupted
[382.990194] Subtest wait-all-interrupted: SUCCESS (0.102s)
[383.092520] [072/132] (637s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-pwrite)
[383.192936] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-pwrite
[390.011355] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-pwrite: SUCCESS (6.820s)
[390.208182] [073/132] (630s left) gem_mmap_gtt (cpuset-big-copy)
[390.267800] Subtest cpuset-big-copy: SKIP (0.000s)
[390.339050] [074/132] (630s left) kms_hdr (invalid-metadata-sizes)
[390.434894] Starting subtest: invalid-metadata-sizes
[390.441463] Subtest invalid-metadata-sizes: SKIP (0.000s)
[390.533952] [075/132] (630s left) kms_atomic_transition (plane-all-modeset-transition-fencing)
[390.632528] Starting subtest: plane-all-modeset-transition-fencing
[390.636650] Subtest plane-all-modeset-transition-fencing: SKIP (0.000s)
[390.733995] [076/132] (630s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-render)
[390.834307] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-render
[397.620900] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-render: SUCCESS (6.786s)
[397.806464] [077/132] (623s left) gem_exec_reloc (basic-concurrent16)
[397.873543] Subtest basic-concurrent16: SKIP (0.000s)
[397.946825] [078/132] (622s left) kms_pm_rpm (legacy-planes-dpms)
[399.788244] Starting subtest: legacy-planes-dpms
[399.790514] Starting dynamic subtest: plane-63
[408.057967] Dynamic subtest plane-63: SUCCESS (8.269s)
[408.069371] Starting dynamic subtest: plane-93
[416.682334] Dynamic subtest plane-93: SUCCESS (8.622s)
[416.693974] Starting dynamic subtest: plane-123
[425.291498] Dynamic subtest plane-123: SUCCESS (8.606s)
[425.304529] Starting dynamic subtest: plane-133
[433.891046] Dynamic subtest plane-133: SUCCESS (8.596s)
[433.894162] Subtest legacy-planes-dpms: SUCCESS (34.102s)
[434.284921] [079/132] (586s left) kms_selftest (drm_cmdline_parser)
[434.322292] Starting subtest: drm_cmdline_parser
[434.365039] Starting dynamic subtest: drm_test_cmdline_force_d_only
[434.492407] Dynamic subtest drm_test_cmdline_force_d_only: SUCCESS (0.124s)
[434.508389] Starting dynamic subtest: drm_test_cmdline_force_D_only_dvi
[434.624295] Dynamic subtest drm_test_cmdline_force_D_only_dvi: SUCCESS (0.132s)
[434.633716] Starting dynamic subtest: drm_test_cmdline_force_D_only_hdmi
[434.756169] Dynamic subtest drm_test_cmdline_force_D_only_hdmi: SUCCESS (0.128s)
[434.766990] Starting dynamic subtest: drm_test_cmdline_force_D_only_not_digital
[434.856277] Dynamic subtest drm_test_cmdline_force_D_only_not_digital: SUCCESS (0.101s)
[434.865461] Starting dynamic subtest: drm_test_cmdline_force_e_only
[435.002735] Dynamic subtest drm_test_cmdline_force_e_only: SUCCESS (0.144s)
[435.013609] Starting dynamic subtest: drm_test_cmdline_res
[435.137450] Dynamic subtest drm_test_cmdline_res: SUCCESS (0.136s)
[435.146789] Starting dynamic subtest: drm_test_cmdline_res_vesa
[435.276073] Dynamic subtest drm_test_cmdline_res_vesa: SUCCESS (0.137s)
[435.286123] Starting dynamic subtest: drm_test_cmdline_res_vesa_rblank
[435.426928] Dynamic subtest drm_test_cmdline_res_vesa_rblank: SUCCESS (0.150s)
[435.436130] Starting dynamic subtest: drm_test_cmdline_res_rblank
[435.579303] Dynamic subtest drm_test_cmdline_res_rblank: SUCCESS (0.152s)
[435.588413] Starting dynamic subtest: drm_test_cmdline_res_bpp
[435.723680] Dynamic subtest drm_test_cmdline_res_bpp: SUCCESS (0.144s)
[435.733272] Starting dynamic subtest: drm_test_cmdline_res_refresh
[435.874528] Dynamic subtest drm_test_cmdline_res_refresh: SUCCESS (0.152s)
[435.883968] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh
[435.995648] Dynamic subtest drm_test_cmdline_res_bpp_refresh: SUCCESS (0.117s)
[436.005013] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_interlaced
[436.134162] Dynamic subtest drm_test_cmdline_res_bpp_refresh_interlaced: SUCCESS (0.136s)
[436.145320] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_margins
[436.276813] Dynamic subtest drm_test_cmdline_res_bpp_refresh_margins: SUCCESS (0.143s)
[436.287530] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_off
[436.421869] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_off: SUCCESS (0.144s)
[436.432919] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_on
[436.575159] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_on: SUCCESS (0.152s)
[436.584157] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_on_analog
[436.706204] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_on_analog: SUCCESS (0.131s)
[436.715185] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_on_digital
[436.843210] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_on_digital: SUCCESS (0.138s)
[436.852305] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_interlaced_margins_force_on
[436.968772] Dynamic subtest drm_test_cmdline_res_bpp_refresh_interlaced_margins_force_on: SUCCESS (0.123s)
[436.977985] Starting dynamic subtest: drm_test_cmdline_res_margins_force_on
[437.097047] Dynamic subtest drm_test_cmdline_res_margins_force_on: SUCCESS (0.127s)
[437.106010] Starting dynamic subtest: drm_test_cmdline_res_vesa_margins
[437.242095] Dynamic subtest drm_test_cmdline_res_vesa_margins: SUCCESS (0.145s)
[437.251029] Starting dynamic subtest: drm_test_cmdline_name
[437.384869] Dynamic subtest drm_test_cmdline_name: SUCCESS (0.141s)
[437.395304] Starting dynamic subtest: drm_test_cmdline_name_bpp
[437.529459] Dynamic subtest drm_test_cmdline_name_bpp: SUCCESS (0.144s)
[437.539002] Starting dynamic subtest: drm_test_cmdline_name_option
[437.685717] Dynamic subtest drm_test_cmdline_name_option: SUCCESS (0.156s)
[437.695310] Starting dynamic subtest: drm_test_cmdline_name_bpp_option
[437.829545] Dynamic subtest drm_test_cmdline_name_bpp_option: SUCCESS (0.143s)
[437.839016] Starting dynamic subtest: drm_test_cmdline_rotate_0
[437.983060] Dynamic subtest drm_test_cmdline_rotate_0: SUCCESS (0.152s)
[437.992376] Starting dynamic subtest: drm_test_cmdline_rotate_90
[438.125367] Dynamic subtest drm_test_cmdline_rotate_90: SUCCESS (0.142s)
[438.134610] Starting dynamic subtest: drm_test_cmdline_rotate_180
[438.265078] Dynamic subtest drm_test_cmdline_rotate_180: SUCCESS (0.139s)
[438.274101] Starting dynamic subtest: drm_test_cmdline_rotate_270
[438.410703] Dynamic subtest drm_test_cmdline_rotate_270: SUCCESS (0.145s)
[438.420276] Starting dynamic subtest: drm_test_cmdline_hmirror
[438.554707] Dynamic subtest drm_test_cmdline_hmirror: SUCCESS (0.143s)
[438.564319] Starting dynamic subtest: drm_test_cmdline_vmirror
[438.680934] Dynamic subtest drm_test_cmdline_vmirror: SUCCESS (0.125s)
[438.690088] Starting dynamic subtest: drm_test_cmdline_margin_options
[438.827083] Dynamic subtest drm_test_cmdline_margin_options: SUCCESS (0.146s)
[438.835932] Starting dynamic subtest: drm_test_cmdline_multiple_options
[438.975575] Dynamic subtest drm_test_cmdline_multiple_options: SUCCESS (0.147s)
[438.984958] Starting dynamic subtest: drm_test_cmdline_bpp_extra_and_option
[439.106164] Dynamic subtest drm_test_cmdline_bpp_extra_and_option: SUCCESS (0.131s)
[439.115504] Starting dynamic subtest: drm_test_cmdline_extra_and_option
[439.211894] Dynamic subtest drm_test_cmdline_extra_and_option: SUCCESS (0.106s)
[439.221294] Starting dynamic subtest: drm_test_cmdline_freestanding_options
[439.297167] Dynamic subtest drm_test_cmdline_freestanding_options: SUCCESS (0.084s)
[439.306562] Starting dynamic subtest: drm_test_cmdline_freestanding_force_e_and_options
[439.402555] Dynamic subtest drm_test_cmdline_freestanding_force_e_and_options: SUCCESS (0.104s)
[439.412810] Starting dynamic subtest: drm_test_cmdline_panel_orientation
[439.514122] Dynamic subtest drm_test_cmdline_panel_orientation: SUCCESS (0.111s)
[439.523069] Starting dynamic subtest: drm_test_cmdline_invalid
[439.615540] Dynamic subtest drm_test_cmdline_invalid: SUCCESS (0.100s)
[439.625410] Starting dynamic subtest: drm_test_cmdline_tv_options
[439.725790] Dynamic subtest drm_test_cmdline_tv_options: SUCCESS (0.112s)
[439.727978] Subtest drm_cmdline_parser: SUCCESS (5.404s)
[439.979633] [080/132] (581s left) kms_ccs (bad-pixel-format-y-tiled-gen12-rc-ccs-cc)
[440.085950] Starting subtest: bad-pixel-format-y-tiled-gen12-rc-ccs-cc
[440.088134] Starting dynamic subtest: pipe-A-eDP-1
[440.110944] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[440.122898] Starting dynamic subtest: pipe-B-eDP-1
[440.144329] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[440.154034] Starting dynamic subtest: pipe-C-eDP-1
[440.174991] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[440.184743] Starting dynamic subtest: pipe-D-eDP-1
[440.207761] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[440.212023] Subtest bad-pixel-format-y-tiled-gen12-rc-ccs-cc: SKIP (0.004s)
[442.334302] [081/132] (578s left) kms_psr (psr2-sprite-blt)
[442.433686] Starting subtest: psr2-sprite-blt
[442.435819] Starting dynamic subtest: eDP-1
[444.108684] Dynamic subtest eDP-1: SUCCESS (1.673s)
[444.110593] Subtest psr2-sprite-blt: SUCCESS (1.674s)
[444.996895] [082/132] (576s left) kms_setmode (invalid-clone-exclusive-crtc)
[445.060160] Starting subtest: invalid-clone-exclusive-crtc
[445.066459] Subtest invalid-clone-exclusive-crtc: SKIP (0.000s)
[445.174624] [083/132] (575s left) kms_flip_event_leak (basic)
[445.280117] Starting subtest: basic
[445.281996] Starting dynamic subtest: pipe-A-eDP-1
[445.697575] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.418s)
[445.708363] Starting dynamic subtest: pipe-B-eDP-1
[446.794208] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.093s)
[446.804724] Starting dynamic subtest: pipe-C-eDP-1
[447.897621] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.104s)
[447.907810] Starting dynamic subtest: pipe-D-eDP-1
[449.026994] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.129s)
[449.029290] Subtest basic: SUCCESS (3.750s)
[449.905512] [084/132] (571s left) gem_workarounds (basic-read)
[449.972649] Starting subtest: basic-read
[449.985389] Subtest basic-read: SUCCESS (0.016s)
[450.151696] [085/132] (571s left) dmabuf_sync_file (import-multiple-read-only)
[450.196736] Starting subtest: import-multiple-read-only
[450.199126] Subtest import-multiple-read-only: SUCCESS (0.003s)
[450.283070] [086/132] (571s left) kms_async_flips (async-flip-with-page-flip-events-linear-atomic)
[450.384815] Starting subtest: async-flip-with-page-flip-events-linear-atomic
[450.757187] Starting dynamic subtest: pipe-A-eDP-1
[453.598569] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.787s)
[453.914076] Starting dynamic subtest: pipe-B-eDP-1
[456.729491] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.770s)
[457.052409] Starting dynamic subtest: pipe-C-eDP-1
[459.864135] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.768s)
[460.182084] Starting dynamic subtest: pipe-D-eDP-1
[462.985061] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.757s)
[462.987201] Subtest async-flip-with-page-flip-events-linear-atomic: SUCCESS (12.549s)
[464.142236] [087/132] (557s left) kms_atomic (plane-overlay-legacy)
[464.257087] Starting subtest: plane-overlay-legacy
[464.259420] Starting dynamic subtest: pipe-A-eDP-1
[464.693683] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.432s)
[464.695968] Subtest plane-overlay-legacy: SUCCESS (0.435s)
[465.586646] [088/132] (555s left) gem_exec_balancer (parallel-balancer)
[465.862125] Starting subtest: parallel-balancer
[466.736217] Subtest parallel-balancer: SUCCESS (0.874s)
[466.874468] [089/132] (554s left) gem_mmap_gtt (basic-write-gtt)
[466.936894] Subtest basic-write-gtt: SKIP (0.000s)
[467.003919] [090/132] (554s left) perf_pmu (render-node-busy)
[467.102556] Starting subtest: render-node-busy
[467.105019] Starting dynamic subtest: rcs0
[467.670058] Dynamic subtest rcs0: SUCCESS (0.569s)
[467.681122] Starting dynamic subtest: bcs0
[468.231478] Dynamic subtest bcs0: SUCCESS (0.559s)
[468.248805] Starting dynamic subtest: vcs0
[469.685897] Dynamic subtest vcs0: SUCCESS (1.450s)
[469.698710] Starting dynamic subtest: vcs1
[471.669891] Dynamic subtest vcs1: SUCCESS (1.981s)
[471.682433] Starting dynamic subtest: vecs0
[473.653914] Dynamic subtest vecs0: SUCCESS (1.981s)
[473.666115] Starting dynamic subtest: ccs0
[474.216081] Dynamic subtest ccs0: SUCCESS (0.560s)
[474.218892] Subtest render-node-busy: SUCCESS (7.117s)
[474.315809] [091/132] (547s left) i915_pm_rpm (system-suspend-execbuf)
[475.869878] Starting subtest: system-suspend-execbuf
[534.259479] Subtest system-suspend-execbuf: SUCCESS (42.980s)
[534.643300] [092/132] (486s left) kms_psr2_sf (psr2-overlay-plane-update-sf-dmg-area)
[539.673277] Starting subtest: psr2-overlay-plane-update-sf-dmg-area
[539.675776] Starting dynamic subtest: pipe-A-eDP-1
[546.293605] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.621s)
[546.304860] Starting dynamic subtest: pipe-B-eDP-1
[552.953041] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.657s)
[552.955492] Subtest psr2-overlay-plane-update-sf-dmg-area: SUCCESS (13.282s)
[553.768045] [093/132] (467s left) kms_vblank (wait-forked)
[553.864747] Starting subtest: wait-forked
[553.866622] Starting dynamic subtest: pipe-A-eDP-1
[555.685442] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.819s)
[555.701744] Starting dynamic subtest: pipe-D-eDP-1
[558.138655] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.453s)
[558.141040] Subtest wait-forked: SUCCESS (4.276s)
[559.027888] [094/132] (462s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-blt)
[559.132188] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-blt
[559.136547] Subtest fbc-2p-primscrn-pri-indfb-draw-blt: SKIP (0.000s)
[559.251465] [095/132] (462s left) gen9_exec_parse (allowed-single)
[559.311208] Subtest allowed-single: SKIP (0.000s)
[559.390171] [096/132] (462s left) syncobj_eventfd (timeline-wait)
[559.448064] Starting subtest: timeline-wait
[559.456829] Subtest timeline-wait: SUCCESS (0.011s)
[559.556681] [097/132] (462s left) kms_vblank (ts-continuation-modeset-rpm)
[559.657452] Starting subtest: ts-continuation-modeset-rpm
[559.659839] Starting dynamic subtest: pipe-A-eDP-1
[562.189775] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.533s)
[562.205490] Starting dynamic subtest: pipe-D-eDP-1
[564.443817] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.248s)
[564.446122] Subtest ts-continuation-modeset-rpm: SUCCESS (4.785s)
[565.270559] [098/132] (456s left) sw_sync (sync_busy)
[565.308428] Starting subtest: sync_busy
[565.310758] Subtest sync_busy: SUCCESS (0.002s)
[565.397869] [099/132] (456s left) gem_ctx_persistence (engines-persistence)
[565.481242] Starting subtest: engines-persistence
[565.483473] Starting dynamic subtest: rcs0
[566.313723] Dynamic subtest rcs0: SUCCESS (0.834s)
[566.326245] Starting dynamic subtest: bcs0
[567.124943] Dynamic subtest bcs0: SUCCESS (0.809s)
[567.138130] Starting dynamic subtest: vcs0
[567.886032] Dynamic subtest vcs0: SUCCESS (0.759s)
[567.899147] Starting dynamic subtest: vcs1
[568.629007] Dynamic subtest vcs1: SUCCESS (0.741s)
[568.640911] Starting dynamic subtest: vecs0
[569.438910] Dynamic subtest vecs0: SUCCESS (0.808s)
[569.452177] Starting dynamic subtest: ccs0
[570.214045] Dynamic subtest ccs0: SUCCESS (0.773s)
[570.216720] Subtest engines-persistence: SUCCESS (4.735s)
[570.321318] [100/132] (451s left) syncobj_basic (bad-handle-to-fd)
[570.391343] Starting subtest: bad-handle-to-fd
[570.393609] Subtest bad-handle-to-fd: SUCCESS (0.000s)
[570.532892] [101/132] (451s left) gem_render_copy (yf-tiled-to-vebox-x-tiled)
[570.597547] Starting subtest: yf-tiled-to-vebox-x-tiled
[570.602337] Subtest yf-tiled-to-vebox-x-tiled: SKIP (0.000s)
[570.812286] [102/132] (451s left) syncobj_timeline (invalid-wait-illegal-handle)
[570.867916] Starting subtest: invalid-wait-illegal-handle
[570.870270] Subtest invalid-wait-illegal-handle: SUCCESS (0.000s)
[571.010242] [103/132] (450s left) i915_drm_fdinfo (memory-info-idle)
[571.048381] Starting subtest: memory-info-idle
[571.050875] Starting dynamic subtest: smem0
[571.108026] Dynamic subtest smem0: SUCCESS (0.061s)
[571.110585] Subtest memory-info-idle: SUCCESS (0.062s)
[571.205480] [104/132] (450s left) gem_softpin (noreloc)
[571.286331] Starting subtest: noreloc
[576.733802] Subtest noreloc: SUCCESS (5.391s)
[576.864688] [105/132] (445s left) i915_pm_sseu (full-enable)
[576.932216] Subtest full-enable: SKIP (0.000s)
[577.071383] [106/132] (445s left) gem_ctx_engines (execute-oneforall)
[577.136913] Starting subtest: execute-oneforall
[578.138101] Subtest execute-oneforall: SUCCESS (1.000s)
[579.237315] [107/132] (442s left) gem_exec_whisper (basic-normal)
[579.294710] Starting subtest: basic-normal
[584.651096] Subtest basic-normal: SUCCESS (5.334s)
[584.841924] [108/132] (437s left) syncobj_basic (bad-flags-handle-to-fd)
[584.918623] Starting subtest: bad-flags-handle-to-fd
[584.920947] Subtest bad-flags-handle-to-fd: SUCCESS (0.000s)
[585.083166] [109/132] (437s left) kms_frontbuffer_tracking (fbc-1p-shrfb-fliptrack-mmap-gtt)
[585.207027] Starting subtest: fbc-1p-shrfb-fliptrack-mmap-gtt
[585.211391] Subtest fbc-1p-shrfb-fliptrack-mmap-gtt: SKIP (0.000s)
[585.357647] [110/132] (436s left) gem_exec_schedule (thriceslice)
[585.445307] Starting subtest: thriceslice
[585.447273] Starting dynamic subtest: rcs0
[585.465256] Dynamic subtest rcs0: SUCCESS (0.030s)
[585.477674] Starting dynamic subtest: bcs0
[585.516409] Dynamic subtest bcs0: SUCCESS (0.050s)
[585.528421] Starting dynamic subtest: vcs0
[585.547760] Dynamic subtest vcs0: SUCCESS (0.030s)
[585.557312] Starting dynamic subtest: vcs1
[585.576024] Dynamic subtest vcs1: SUCCESS (0.027s)
[585.585475] Starting dynamic subtest: vecs0
[585.605144] Dynamic subtest vecs0: SUCCESS (0.028s)
[585.614641] Starting dynamic subtest: ccs0
[585.656488] Dynamic subtest ccs0: SUCCESS (0.051s)
[585.658711] Subtest thriceslice: SUCCESS (0.223s)
[585.984905] [111/132] (436s left) syncobj_wait (multi-wait-submitted-signaled)
[586.031785] Starting subtest: multi-wait-submitted-signaled
[586.034011] Subtest multi-wait-submitted-signaled: SUCCESS (0.000s)
[586.169356] [112/132] (436s left) kms_big_fb (yf-tiled-8bpp-rotate-270)
[586.276319] Starting subtest: yf-tiled-8bpp-rotate-270
[586.280847] Subtest yf-tiled-8bpp-rotate-270: SKIP (0.000s)
[586.395649] [113/132] (436s left) gem_userptr_blits (access-control)
[586.476108] Starting subtest: access-control
[586.480241] Subtest access-control: SKIP (0.000s)
[586.643513] [114/132] (435s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-mmap-cpu)
[586.748384] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-mmap-cpu
[590.357395] Subtest fbc-1p-primscrn-cur-indfb-draw-mmap-cpu: SUCCESS (3.612s)
[591.556346] [115/132] (430s left) gem_ctx_persistence (idempotent)
[591.627409] Starting subtest: idempotent
[591.629815] Subtest idempotent: SUCCESS (0.000s)
[591.758599] [116/132] (430s left) kms_flip (2x-flip-vs-fences-interruptible)
[591.859179] Starting subtest: 2x-flip-vs-fences-interruptible
[591.863238] Subtest 2x-flip-vs-fences-interruptible: SKIP (0.000s)
[592.011896] [117/132] (430s left) gem_userptr_blits (map-fixed-invalidate)
[592.083312] Starting subtest: map-fixed-invalidate
[592.087938] Subtest map-fixed-invalidate: SKIP (0.000s)
[592.246049] [118/132] (430s left) gem_bad_reloc (negative-reloc-lut)
[592.310105] Subtest negative-reloc-lut: SKIP (0.000s)
[592.406776] [119/132] (430s left) kms_fbcon_fbt (fbc-suspend)
[592.476016] Starting subtest: fbc-suspend
[641.419616] Subtest fbc-suspend: SUCCESS (18.984s)
[642.755140] [120/132] (379s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-mmap-gtt)
[642.874125] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-mmap-gtt
[642.879149] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[643.014609] [121/132] (379s left) kms_psr (psr-cursor-mmap-gtt)
[643.110339] Starting subtest: psr-cursor-mmap-gtt
[643.113038] Starting dynamic subtest: eDP-1
[644.865136] Dynamic subtest eDP-1: SUCCESS (1.751s)
[644.867379] Subtest psr-cursor-mmap-gtt: SUCCESS (1.752s)
[645.753523] [122/132] (377s left) kms_color_pipeline (plane-lut1d)
[645.849012] Starting subtest: plane-lut1d
[645.861522] Starting dynamic subtest: pipe-A-eDP-1
[646.643094] Dynamic subtest pipe-A-eDP-1: FAIL (0.305s)
[647.220128] Starting dynamic subtest: pipe-B-eDP-1
[648.111870] Dynamic subtest pipe-B-eDP-1: FAIL (0.302s)
[648.559156] Starting dynamic subtest: pipe-C-eDP-1
[649.486608] Dynamic subtest pipe-C-eDP-1: FAIL (0.257s)
[649.890499] Starting dynamic subtest: pipe-D-eDP-1
[650.865865] Dynamic subtest pipe-D-eDP-1: FAIL (0.268s)
[650.868213] Subtest plane-lut1d: FAIL (4.590s)
[651.300724] [123/132] (371s left) gem_userptr_blits (readonly-pwrite-unsync)
[651.378967] Subtest readonly-pwrite-unsync: SKIP (0.000s)
[651.544744] [124/132] (371s left) gem_close (basic)
[651.610039] Starting subtest: basic
[651.612677] Subtest basic: SUCCESS (0.000s)
[651.727656] [125/132] (371s left) kms_chamelium_color (ctm-red-to-blue)
[651.825545] Subtest ctm-red-to-blue: SKIP (0.000s)
[651.871631] [126/132] (371s left) kms_cursor_crc (cursor-rapid-movement-256x256)
[652.110602] Starting subtest: cursor-rapid-movement-256x256
[652.115908] Starting dynamic subtest: pipe-A-eDP-1
[652.654833] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.540s)
[652.684544] Starting dynamic subtest: pipe-D-eDP-1
[653.880865] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.203s)
[653.883508] Subtest cursor-rapid-movement-256x256: SUCCESS (1.768s)
[654.769546] [127/132] (368s left) kms_cursor_legacy (basic-flip-after-cursor-varying-size)
[654.894946] Starting subtest: basic-flip-after-cursor-varying-size
[655.817384] Subtest basic-flip-after-cursor-varying-size: SUCCESS (0.924s)
[656.698893] [128/132] (366s left) kms_psr (fbc-psr-sprite-mmap-gtt)
[656.790093] Starting subtest: fbc-psr-sprite-mmap-gtt
[656.792697] Starting dynamic subtest: eDP-1
[656.797331] Dynamic subtest eDP-1: SKIP (0.000s)
[656.802158] Subtest fbc-psr-sprite-mmap-gtt: SKIP (0.001s)
[656.893249] [129/132] (366s left) kms_big_fb (yf-tiled-16bpp-rotate-90)
[656.997169] Starting subtest: yf-tiled-16bpp-rotate-90
[657.002875] Subtest yf-tiled-16bpp-rotate-90: SKIP (0.000s)
[657.133108] [130/132] (366s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-onoff)
[657.232317] Starting subtest: fbc-2p-scndscrn-spr-indfb-onoff
[657.237540] Subtest fbc-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s)
[657.344152] [131/132] (365s left) kms_prop_blob (blob-prop-lifetime)
[657.402371] Starting subtest: blob-prop-lifetime
[657.404809] Subtest blob-prop-lifetime: SUCCESS (0.001s)
[657.538877] [132/132] (365s left) kms_big_fb (y-tiled-16bpp-rotate-270)
[657.653972] Starting subtest: y-tiled-16bpp-rotate-270
[657.658371] Subtest y-tiled-16bpp-rotate-270: SKIP (0.000s)
[657.784000] Closing watchdogs
results: parsing output: 0/ for test: gem_exec_schedule
results: parsing output: 1/ for test: kms_frontbuffer_tracking
results: parsing output: 2/ for test: kms_frontbuffer_tracking
results: parsing output: 3/ for test: syncobj_timeline
results: parsing output: 4/ for test: gem_softpin
results: parsing output: 5/ for test: gem_mmap_gtt
results: parsing output: 6/ for test: kms_content_protection
results: parsing output: 7/ for test: kms_frontbuffer_tracking
results: parsing output: 8/ for test: gem_mmap_gtt
results: parsing output: 9/ for test: kms_flip_scaled_crc
results: parsing output: 10/ for test: kms_cursor_crc
results: parsing output: 11/ for test: perf_pmu
results: parsing output: 12/ for test: kms_frontbuffer_tracking
results: parsing output: 13/ for test: gem_tiled_pread_basic
results: parsing output: 14/ for test: kms_psr
results: parsing output: 15/ for test: gem_render_copy
results: parsing output: 16/ for test: kms_color
results: parsing output: 17/ for test: gem_exec_fence
results: parsing output: 18/ for test: kms_flip
results: parsing output: 19/ for test: gem_mmap_gtt
results: parsing output: 20/ for test: syncobj_timeline
results: parsing output: 21/ for test: kms_lease
results: parsing output: 22/ for test: gem_exec_whisper
results: parsing output: 23/ for test: gem_exec_balancer
results: parsing output: 24/ for test: gem_fenced_exec_thrash
results: parsing output: 25/ for test: kms_chamelium_frames
results: parsing output: 26/ for test: kms_big_fb
results: parsing output: 27/ for test: kms_big_fb
results: parsing output: 28/ for test: api_intel_bb
results: parsing output: 29/ for test: kms_psr
results: parsing output: 30/ for test: gem_eio
results: parsing output: 31/ for test: kms_feature_discovery
results: parsing output: 32/ for test: kms_frontbuffer_tracking
results: parsing output: 33/ for test: kms_flip
results: parsing output: 34/ for test: i915_pciid
results: parsing output: 35/ for test: kms_plane_scaling
results: parsing output: 36/ for test: gem_exec_flush
results: parsing output: 37/ for test: kms_big_fb
results: parsing output: 38/ for test: kms_pipe_stress
results: parsing output: 39/ for test: gem_exec_reloc
results: parsing output: 40/ for test: gem_pxp
results: parsing output: 41/ for test: kms_rotation_crc
results: parsing output: 42/ for test: api_intel_bb
results: parsing output: 43/ for test: kms_pm_backlight
results: parsing output: 44/ for test: kms_addfb_basic
results: parsing output: 45/ for test: gem_userptr_blits
results: parsing output: 46/ for test: kms_invalid_mode
results: parsing output: 47/ for test: kms_frontbuffer_tracking
results: parsing output: 48/ for test: kms_ccs
results: parsing output: 49/ for test: kms_cursor_crc
results: parsing output: 50/ for test: kms_frontbuffer_tracking
results: parsing output: 51/ for test: syncobj_timeline
results: parsing output: 52/ for test: kms_frontbuffer_tracking
results: parsing output: 53/ for test: kms_ccs
results: parsing output: 54/ for test: kms_big_fb
results: parsing output: 55/ for test: kms_plane
results: parsing output: 56/ for test: kms_getfb
results: parsing output: 57/ for test: kms_flip
results: parsing output: 58/ for test: kms_addfb_basic
results: parsing output: 59/ for test: kms_ccs
results: parsing output: 60/ for test: kms_frontbuffer_tracking
results: parsing output: 61/ for test: vgem_basic
results: parsing output: 62/ for test: gem_ctx_shared
results: parsing output: 63/ for test: kms_atomic_interruptible
results: parsing output: 64/ for test: kms_psr2_sf
results: parsing output: 65/ for test: kms_cursor_legacy
results: parsing output: 66/ for test: kms_frontbuffer_tracking
results: parsing output: 67/ for test: kms_frontbuffer_tracking
results: parsing output: 68/ for test: gem_ppgtt
results: parsing output: 69/ for test: kms_flip
results: parsing output: 70/ for test: syncobj_timeline
results: parsing output: 71/ for test: kms_frontbuffer_tracking
results: parsing output: 72/ for test: gem_mmap_gtt
results: parsing output: 73/ for test: kms_hdr
results: parsing output: 74/ for test: kms_atomic_transition
results: parsing output: 75/ for test: kms_frontbuffer_tracking
results: parsing output: 76/ for test: gem_exec_reloc
results: parsing output: 77/ for test: kms_pm_rpm
results: parsing output: 78/ for test: kms_selftest
results: parsing output: 79/ for test: kms_ccs
results: parsing output: 80/ for test: kms_psr
results: parsing output: 81/ for test: kms_setmode
results: parsing output: 82/ for test: kms_flip_event_leak
results: parsing output: 83/ for test: gem_workarounds
results: parsing output: 84/ for test: dmabuf_sync_file
results: parsing output: 85/ for test: kms_async_flips
results: parsing output: 86/ for test: kms_atomic
results: parsing output: 87/ for test: gem_exec_balancer
results: parsing output: 88/ for test: gem_mmap_gtt
results: parsing output: 89/ for test: perf_pmu
results: parsing output: 90/ for test: i915_pm_rpm
results: parsing output: 91/ for test: kms_psr2_sf
results: parsing output: 92/ for test: kms_vblank
results: parsing output: 93/ for test: kms_frontbuffer_tracking
results: parsing output: 94/ for test: gen9_exec_parse
results: parsing output: 95/ for test: syncobj_eventfd
results: parsing output: 96/ for test: kms_vblank
results: parsing output: 97/ for test: sw_sync
results: parsing output: 98/ for test: gem_ctx_persistence
results: parsing output: 99/ for test: syncobj_basic
results: parsing output: 100/ for test: gem_render_copy
results: parsing output: 101/ for test: syncobj_timeline
results: parsing output: 102/ for test: i915_drm_fdinfo
results: parsing output: 103/ for test: gem_softpin
results: parsing output: 104/ for test: i915_pm_sseu
results: parsing output: 105/ for test: gem_ctx_engines
results: parsing output: 106/ for test: gem_exec_whisper
results: parsing output: 107/ for test: syncobj_basic
results: parsing output: 108/ for test: kms_frontbuffer_tracking
results: parsing output: 109/ for test: gem_exec_schedule
results: parsing output: 110/ for test: syncobj_wait
results: parsing output: 111/ for test: kms_big_fb
results: parsing output: 112/ for test: gem_userptr_blits
results: parsing output: 113/ for test: kms_frontbuffer_tracking
results: parsing output: 114/ for test: gem_ctx_persistence
results: parsing output: 115/ for test: kms_flip
results: parsing output: 116/ for test: gem_userptr_blits
results: parsing output: 117/ for test: gem_bad_reloc
results: parsing output: 118/ for test: kms_fbcon_fbt
results: parsing output: 119/ for test: kms_frontbuffer_tracking
results: parsing output: 120/ for test: kms_psr
results: parsing output: 121/ for test: kms_color_pipeline
results: parsing output: 122/ for test: gem_userptr_blits
results: parsing output: 123/ for test: gem_close
results: parsing output: 124/ for test: kms_chamelium_color
results: parsing output: 125/ for test: kms_cursor_crc
results: parsing output: 126/ for test: kms_cursor_legacy
results: parsing output: 127/ for test: kms_psr
results: parsing output: 128/ for test: kms_big_fb
results: parsing output: 129/ for test: kms_frontbuffer_tracking
results: parsing output: 130/ for test: kms_prop_blob
results: parsing output: 131/ for test: kms_big_fb
Done.