[65.539009] Initializing watchdogs
[65.539099]   /dev/watchdog0
[65.568450] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:03:00.0: 8086:4905 Intel Dg1 (Gen12) DG1 [Iris Xe MAX Graphics]
[65.583347] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[65.587989] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[65.591054] [001/133] (960s left) kms_content_protection (dp-mst-lic-type-0-hdcp14)
[67.151701] Starting subtest: dp-mst-lic-type-0-hdcp14
[67.154603] Subtest dp-mst-lic-type-0-hdcp14: SKIP (0.000s)
[67.386613] [002/133] (958s left) core_getversion (all-cards)
[67.433103] Starting subtest: all-cards
[67.450537] Subtest all-cards: SUCCESS (0.020s)
[67.524872] [003/133] (958s left) kms_atomic_interruptible (legacy-dpms)
[69.014048] Starting subtest: legacy-dpms
[69.015483] Starting dynamic subtest: pipe-A-HDMI-A-1
[75.205548] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (6.178s)
[75.207139] Subtest legacy-dpms: SUCCESS (6.180s)
[75.382621] [004/133] (950s left) kms_plane (pixel-format-y-tiled-ccs-modifier-source-clamping)
[76.868177] Starting subtest: pixel-format-y-tiled-ccs-modifier-source-clamping
[76.877939] Subtest pixel-format-y-tiled-ccs-modifier-source-clamping: SKIP (0.000s)
[77.013386] [005/133] (949s left) kms_atomic_transition (plane-primary-toggle-with-vblank-wait)
[78.505203] Starting subtest: plane-primary-toggle-with-vblank-wait
[78.506673] Starting dynamic subtest: pipe-A-HDMI-A-1
[78.727576] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.221s)
[78.865337] Starting dynamic subtest: pipe-B-HDMI-A-1
[79.091525] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.235s)
[79.148735] Subtest plane-primary-toggle-with-vblank-wait: SUCCESS (0.644s)
[79.369956] [006/133] (947s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-mmap-gtt)
[80.863166] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-mmap-gtt
[80.866402] Subtest fbc-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[81.089891] [007/133] (945s left) kms_psr (fbc-psr2-primary-mmap-cpu)
[82.619726] Subtest fbc-psr2-primary-mmap-cpu: SKIP (0.000s)
[82.684429] [008/133] (944s left) perf (invalid-oa-exponent)
[82.833422] Starting subtest: invalid-oa-exponent
[82.859712] Subtest invalid-oa-exponent: SUCCESS (0.026s)
[82.921474] [009/133] (943s left) gem_eio (create-ext)
[83.061109] Starting subtest: create-ext
[83.243426] Subtest create-ext: SUCCESS (0.181s)
[84.874153] [010/133] (942s left) kms_color (invalid-degamma-lut-sizes)
[86.378244] Starting subtest: invalid-degamma-lut-sizes
[86.379798] Starting dynamic subtest: pipe-A
[86.425696] Dynamic subtest pipe-A: SUCCESS (0.046s)
[86.434751] Starting dynamic subtest: pipe-B
[86.437478] Dynamic subtest pipe-B: SUCCESS (0.001s)
[86.446378] Starting dynamic subtest: pipe-C
[86.448142] Dynamic subtest pipe-C: SUCCESS (0.001s)
[86.456968] Starting dynamic subtest: pipe-D
[86.458588] Dynamic subtest pipe-D: SUCCESS (0.001s)
[86.460163] Subtest invalid-degamma-lut-sizes: SUCCESS (0.048s)
[86.616291] [011/133] (940s left) gem_softpin (allocator-basic)
[86.666277] Starting subtest: allocator-basic
[86.935129] Subtest allocator-basic: SUCCESS (0.265s)
[87.170978] [012/133] (939s left) kms_psr2_sf (psr2-overlay-plane-update-sf-dmg-area)
[88.659659] Subtest psr2-overlay-plane-update-sf-dmg-area: SKIP (0.000s)
[88.737184] [013/133] (938s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-0)
[90.258053] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-0
[91.374666] Subtest y-tiled-max-hw-stride-64bpp-rotate-0: SUCCESS (1.116s)
[91.635776] [014/133] (935s left) kms_psr (pr-primary-render)
[93.122320] Subtest pr-primary-render: SKIP (0.000s)
[93.201294] [015/133] (934s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-pwrite)
[94.771352] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-pwrite
[94.774959] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[95.020725] [016/133] (932s left) kms_psr2_sf (pr-cursor-plane-move-continuous-exceed-sf)
[96.508774] Subtest pr-cursor-plane-move-continuous-exceed-sf: SKIP (0.000s)
[96.579947] [017/133] (930s left) gem_ccs (ctrl-surf-copy)
[96.632172] Starting subtest: ctrl-surf-copy
[96.635337] Subtest ctrl-surf-copy: SKIP (0.000s)
[96.775674] [018/133] (930s left) perf (invalid-oa-metric-set-id)
[96.951699] Starting subtest: invalid-oa-metric-set-id
[96.971600] Subtest invalid-oa-metric-set-id: SUCCESS (0.019s)
[97.032085] [019/133] (930s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite)
[98.525987] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite
[98.529981] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[98.770921] [020/133] (929s left) gem_pxp (create-regular-buffer)
[101.363892] Starting subtest: create-regular-buffer
[101.366596] Subtest create-regular-buffer: SKIP (0.000s)
[101.491317] [021/133] (926s left) gem_eio (in-flight-contexts-10ms)
[101.623371] Starting subtest: in-flight-contexts-10ms
[114.871996] Subtest in-flight-contexts-10ms: SUCCESS (13.246s)
[116.508321] [022/133] (911s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-render)
[118.000709] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-render
[118.004256] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-render: SKIP (0.000s)
[118.236700] [023/133] (909s left) gem_exec_schedule (u-fairslice-all)
[118.300686] Starting subtest: u-fairslice-all
[120.370727] Subtest u-fairslice-all: SUCCESS (2.077s)
[120.852129] [024/133] (907s left) core_getstats (basic)
[120.896202] Starting subtest: basic
[120.897823] Subtest basic: SUCCESS (0.000s)
[121.059641] [025/133] (907s left) kms_ccs (crc-primary-rotation-180-4-tiled-mtl-rc-ccs)
[122.544180] Starting subtest: crc-primary-rotation-180-4-tiled-mtl-rc-ccs
[122.545649] Starting dynamic subtest: pipe-A-HDMI-A-1
[122.562108] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.001s)
[122.571694] Starting dynamic subtest: pipe-B-HDMI-A-1
[122.586285] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.001s)
[122.595608] Starting dynamic subtest: pipe-C-HDMI-A-1
[122.610613] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.001s)
[122.619828] Starting dynamic subtest: pipe-D-HDMI-A-1
[122.636115] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.001s)
[122.639268] Subtest crc-primary-rotation-180-4-tiled-mtl-rc-ccs: SKIP (0.009s)
[122.835188] [026/133] (905s left) kms_ccs (bad-pixel-format-4-tiled-dg2-mc-ccs)
[124.317443] Starting subtest: bad-pixel-format-4-tiled-dg2-mc-ccs
[124.319126] Starting dynamic subtest: pipe-A-HDMI-A-1
[124.335791] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.000s)
[124.345648] Starting dynamic subtest: pipe-B-HDMI-A-1
[124.361111] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.000s)
[124.370329] Starting dynamic subtest: pipe-C-HDMI-A-1
[124.383132] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.000s)
[124.392338] Starting dynamic subtest: pipe-D-HDMI-A-1
[124.405845] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.000s)
[124.408601] Subtest bad-pixel-format-4-tiled-dg2-mc-ccs: SKIP (0.005s)
[124.590387] [027/133] (903s left) sw_sync (alloc_fence)
[124.632659] Starting subtest: alloc_fence
[124.634119] Subtest alloc_fence: SUCCESS (0.000s)
[124.766999] [028/133] (903s left) i915_pm_rps (basic-api)
[124.817130] Starting subtest: basic-api
[124.820177] Subtest basic-api: SKIP (0.000s)
[124.994730] [029/133] (903s left) kms_cursor_legacy (cursorb-vs-flipa-toggle)
[126.480380] Starting subtest: cursorB-vs-flipA-toggle
[126.485034] Subtest cursorB-vs-flipA-toggle: SKIP (0.003s)
[126.682782] [030/133] (902s left) kms_cursor_crc (cursor-rapid-movement-128x42)
[128.351111] Starting subtest: cursor-rapid-movement-128x42
[128.357288] Starting dynamic subtest: pipe-A-HDMI-A-1
[128.791604] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.435s)
[128.822397] Starting dynamic subtest: pipe-D-HDMI-A-1
[129.132870] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.318s)
[129.134402] Subtest cursor-rapid-movement-128x42: SUCCESS (0.781s)
[129.621895] [031/133] (899s left) kms_dp_link_training (non-uhbr-sst)
[131.107474] Starting subtest: non-uhbr-sst
[131.114230] Subtest non-uhbr-sst: SKIP (0.000s)
[131.315643] [032/133] (897s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-mmap-cpu)
[132.806115] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-mmap-cpu
[132.809437] Subtest psr-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[133.066422] [033/133] (896s left) gem_exec_parallel (engines)
[133.121133] Starting subtest: engines
[133.122708] Starting dynamic subtest: basic
[134.715569] Dynamic subtest basic: SUCCESS (1.594s)
[134.725915] Starting dynamic subtest: contexts
[139.293487] Dynamic subtest contexts: SUCCESS (4.574s)
[139.303198] Starting dynamic subtest: fds
[143.971256] Dynamic subtest fds: SUCCESS (4.677s)
[143.981221] Starting dynamic subtest: userptr
[145.476952] Dynamic subtest userptr: SUCCESS (1.509s)
[145.478840] Subtest engines: SUCCESS (12.355s)
[145.848104] [034/133] (883s left) gem_eio (in-flight-immediate)
[146.050368] Starting subtest: in-flight-immediate
[150.591473] Subtest in-flight-immediate: SUCCESS (4.543s)
[152.242638] [FACT gem_eio (in-flight-immediate)] new: kernel.kmod_is_loaded.vgem: true
[152.248330] [035/133] (877s left) prime_mmap (test_forked)
[152.292170] Starting subtest: test_forked
[152.293490] Starting dynamic subtest: test_forked-smem
[152.360721] Dynamic subtest test_forked-smem: SUCCESS (0.069s)
[152.370841] Starting dynamic subtest: test_forked-lmem0
[152.430857] Dynamic subtest test_forked-lmem0: SUCCESS (0.070s)
[152.432275] Subtest test_forked: SUCCESS (0.139s)
[152.627867] [036/133] (876s left) kms_dsc (dsc-with-formats)
[154.109641] Starting subtest: dsc-with-formats
[154.161521] Subtest dsc-with-formats: SKIP (0.002s)
[154.317757] [037/133] (875s left) prime_busy (hang)
[154.366871] Starting subtest: hang
[154.368394] Starting dynamic subtest: rcs0
[180.468161] Dynamic subtest rcs0: SUCCESS (26.104s)
[180.478232] Starting dynamic subtest: bcs0
[187.554171] Dynamic subtest bcs0: SUCCESS (7.085s)
[187.564255] Starting dynamic subtest: vcs0
[194.594138] Dynamic subtest vcs0: SUCCESS (7.041s)
[194.604274] Starting dynamic subtest: vcs1
[201.571317] Dynamic subtest vcs1: SUCCESS (6.975s)
[201.581649] Starting dynamic subtest: vecs0
[208.544721] Dynamic subtest vecs0: SUCCESS (6.975s)
[208.546526] Subtest hang: SUCCESS (54.184s)
[208.702761] [038/133] (820s left) kms_vblank (wait-idle)
[210.187529] Starting subtest: wait-idle
[210.189083] Starting dynamic subtest: pipe-A-HDMI-A-1
[212.520435] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (2.331s)
[212.533727] Starting dynamic subtest: pipe-D-HDMI-A-1
[214.693928] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (2.169s)
[214.695684] Subtest wait-idle: SUCCESS (4.507s)
[214.899198] [039/133] (814s left) kms_pm_rpm (package-g7)
[219.026489] Starting subtest: package-g7
[219.030134] Subtest package-g7: SKIP (0.000s)
[219.983472] [040/133] (809s left) kms_cursor_legacy (flip-vs-cursor-varying-size)
[221.467702] Starting subtest: flip-vs-cursor-varying-size
[235.896992] Subtest flip-vs-cursor-varying-size: SUCCESS (14.430s)
[236.111951] [041/133] (793s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-msflip-blt)
[237.602743] Starting subtest: psr-1p-primscrn-shrfb-msflip-blt
[237.606702] Subtest psr-1p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[237.869811] [042/133] (792s left) syncobj_timeline (single-wait-all-for-submit-signaled)
[237.915804] Starting subtest: single-wait-all-for-submit-signaled
[237.917195] Subtest single-wait-all-for-submit-signaled: SUCCESS (0.001s)
[238.055665] [043/133] (792s left) perf (gen12-group-exclusive-stream-ctx-handle)
[238.183693] Starting subtest: gen12-group-exclusive-stream-ctx-handle
[238.209998] Subtest gen12-group-exclusive-stream-ctx-handle: SUCCESS (0.026s)
[238.306170] [044/133] (791s left) gem_wait (busy)
[238.367513] Starting subtest: busy
[238.369209] Starting dynamic subtest: all-engines
[238.965855] Dynamic subtest all-engines: SUCCESS (0.598s)
[238.976267] Starting dynamic subtest: rcs0
[239.504338] Dynamic subtest rcs0: SUCCESS (0.538s)
[239.514530] Starting dynamic subtest: bcs0
[240.042198] Dynamic subtest bcs0: SUCCESS (0.537s)
[240.052361] Starting dynamic subtest: vcs0
[240.581363] Dynamic subtest vcs0: SUCCESS (0.539s)
[240.591700] Starting dynamic subtest: vcs1
[241.120351] Dynamic subtest vcs1: SUCCESS (0.538s)
[241.130695] Starting dynamic subtest: vecs0
[241.658382] Dynamic subtest vecs0: SUCCESS (0.538s)
[241.659925] Subtest busy: SUCCESS (3.291s)
[241.994905] [045/133] (788s left) gen9_exec_parse (bb-secure)
[242.047125] Subtest bb-secure: SKIP (0.000s)
[242.118235] [046/133] (788s left) kms_cursor_edge_walk (128x128-right-edge)
[243.600505] Starting subtest: 128x128-right-edge
[243.602150] Starting dynamic subtest: pipe-A-HDMI-A-1
[246.931872] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (3.329s)
[246.942596] Starting dynamic subtest: pipe-D-HDMI-A-1
[250.145575] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (3.211s)
[250.147244] Subtest 128x128-right-edge: SUCCESS (6.544s)
[250.366723] [047/133] (780s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-mmap-gtt)
[251.858717] Starting subtest: psr-2p-primscrn-pri-indfb-draw-mmap-gtt
[251.861962] Subtest psr-2p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[252.092858] [048/133] (778s left) prime_mmap (test_forked_cpu_write)
[252.159259] Starting subtest: test_forked_cpu_write
[252.160964] Starting dynamic subtest: test_forked_cpu_write-smem
[252.172570] Dynamic subtest test_forked_cpu_write-smem: SUCCESS (0.014s)
[252.185906] Starting dynamic subtest: test_forked_cpu_write-lmem0
[252.189630] Dynamic subtest test_forked_cpu_write-lmem0: SUCCESS (0.015s)
[252.193551] Subtest test_forked_cpu_write: SUCCESS (0.030s)
[252.393548] [049/133] (778s left) kms_addfb_basic (small-bo)
[253.877489] Starting subtest: small-bo
[253.879125] Subtest small-bo: SUCCESS (0.000s)
[254.112464] [050/133] (776s left) kms_chamelium_audio (dp-audio)
[255.639777] Subtest dp-audio: SKIP (0.000s)
[255.752739] [051/133] (775s left) kms_chamelium_edid (hdmi-edid-change-during-suspend)
[257.282690] Subtest hdmi-edid-change-during-suspend: SKIP (0.000s)
[257.395223] [052/133] (773s left) kms_frontbuffer_tracking (psr-shrfb-scaledprimary)
[258.886207] Starting subtest: psr-shrfb-scaledprimary
[258.889830] Subtest psr-shrfb-scaledprimary: SKIP (0.000s)
[259.130979] [053/133] (771s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-32bpp-yftileccs-downscaling)
[260.614659] Starting subtest: flip-32bpp-yftile-to-32bpp-yftileccs-downscaling
[260.617825] Subtest flip-32bpp-yftile-to-32bpp-yftileccs-downscaling: SKIP (0.000s)
[260.841904] [054/133] (770s left) perf (i915-ref-count)
[260.953841] Starting subtest: i915-ref-count
[260.983136] Subtest i915-ref-count: SUCCESS (0.028s)
[261.060482] [055/133] (770s left) kms_joiner (invalid-modeset-force-big-joiner)
[262.546540] Starting subtest: invalid-modeset-force-big-joiner
[262.549927] Subtest invalid-modeset-force-big-joiner: SKIP (0.000s)
[262.747996] [056/133] (768s left) kms_cursor_crc (cursor-alpha-opaque)
[264.231387] Starting subtest: cursor-alpha-opaque
[264.232950] Starting dynamic subtest: pipe-A-HDMI-A-1
[264.869837] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.636s)
[264.880310] Starting dynamic subtest: pipe-D-HDMI-A-1
[265.344726] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.472s)
[265.348374] Subtest cursor-alpha-opaque: SUCCESS (1.112s)
[266.061200] [057/133] (765s left) kms_legacy_colorkey (basic)
[267.543241] Starting subtest: basic
[267.544730] Starting dynamic subtest: pipe-A
[267.634162] Dynamic subtest pipe-A: SUCCESS (0.090s)
[267.655165] Starting dynamic subtest: pipe-B
[267.656875] Dynamic subtest pipe-B: SUCCESS (0.001s)
[267.696733] Starting dynamic subtest: pipe-C
[267.699164] Dynamic subtest pipe-C: SUCCESS (0.001s)
[267.747219] Starting dynamic subtest: pipe-D
[267.749189] Dynamic subtest pipe-D: SUCCESS (0.002s)
[267.751207] Subtest basic: SUCCESS (0.100s)
[267.834900] [058/133] (763s left) kms_big_fb (linear-max-hw-stride-64bpp-rotate-180-hflip)
[269.337941] Starting subtest: linear-max-hw-stride-64bpp-rotate-180-hflip
[269.341536] Subtest linear-max-hw-stride-64bpp-rotate-180-hflip: SKIP (0.000s)
[269.592914] [059/133] (762s left) kms_addfb_basic (bad-pitch-32)
[269.639116] Starting subtest: bad-pitch-32
[269.653098] Subtest bad-pitch-32: SUCCESS (0.000s)
[271.339143] [060/133] (760s left) gem_render_copy (x-tiled-to-vebox-y-tiled)
[271.409294] Starting subtest: x-tiled-to-vebox-y-tiled
[271.410605] Starting dynamic subtest: smem
[271.492624] Dynamic subtest smem: SUCCESS (0.083s)
[271.502761] Starting dynamic subtest: lmem0
[272.251587] Dynamic subtest lmem0: SUCCESS (0.755s)
[272.253178] Subtest x-tiled-to-vebox-y-tiled: SUCCESS (0.839s)
[272.535641] [061/133] (759s left) gem_exec_reloc (basic-range)
[272.585999] Subtest basic-range: SKIP (0.000s)
[272.696247] [062/133] (759s left) kms_big_fb (yf-tiled-64bpp-rotate-0)
[274.196486] Starting subtest: yf-tiled-64bpp-rotate-0
[274.199974] Subtest yf-tiled-64bpp-rotate-0: SKIP (0.000s)
[274.445536] [063/133] (757s left) syncobj_wait (wait-all-for-submit-snapshot)
[274.493230] Starting subtest: wait-all-for-submit-snapshot
[274.575710] Subtest wait-all-for-submit-snapshot: SUCCESS (0.082s)
[274.793282] [064/133] (757s left) kms_async_flips (invalid-async-flip)
[276.332861] Starting subtest: invalid-async-flip
[276.571379] Starting dynamic subtest: pipe-A-HDMI-A-1
[276.994012] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.423s)
[277.173602] Starting dynamic subtest: pipe-B-HDMI-A-1
[277.260441] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.095s)
[277.434208] Starting dynamic subtest: pipe-C-HDMI-A-1
[277.533978] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.108s)
[277.684767] Starting dynamic subtest: pipe-D-HDMI-A-1
[277.782288] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.106s)
[277.783789] Subtest invalid-async-flip: SUCCESS (1.452s)
[278.219849] [065/133] (754s left) kms_flip (single-buffer-flip-vs-dpms-off-vs-modeset-interruptible)
[279.709847] Starting subtest: single-buffer-flip-vs-dpms-off-vs-modeset-interruptible
[279.715053] Starting dynamic subtest: A-HDMI-A1
[280.393237] Dynamic subtest A-HDMI-A1: SUCCESS (0.678s)
[280.403592] Starting dynamic subtest: B-HDMI-A1
[281.051905] Dynamic subtest B-HDMI-A1: SUCCESS (0.657s)
[281.062410] Starting dynamic subtest: C-HDMI-A1
[281.711124] Dynamic subtest C-HDMI-A1: SUCCESS (0.658s)
[281.721530] Starting dynamic subtest: D-HDMI-A1
[282.385319] Dynamic subtest D-HDMI-A1: SUCCESS (0.673s)
[282.391206] Subtest single-buffer-flip-vs-dpms-off-vs-modeset-interruptible: SUCCESS (2.678s)
[282.628907] [066/133] (749s left) kms_frontbuffer_tracking (fbc-suspend)
[284.126471] Starting subtest: fbc-suspend
[330.184254] Subtest fbc-suspend: SUCCESS (22.522s)
[333.456689] [067/133] (702s left) syncobj_timeline (invalid-transfer-bad-pad)
[333.505926] Starting subtest: invalid-transfer-bad-pad
[333.507725] Subtest invalid-transfer-bad-pad: SUCCESS (0.000s)
[333.631609] [068/133] (702s left) kms_big_fb (4-tiled-64bpp-rotate-90)
[335.134143] Starting subtest: 4-tiled-64bpp-rotate-90
[335.138108] Subtest 4-tiled-64bpp-rotate-90: SKIP (0.000s)
[335.373801] [069/133] (700s left) gem_ctx_persistence (saturated-hostile-nopreempt)
[335.423807] Starting subtest: saturated-hostile-nopreempt
[335.425235] Starting dynamic subtest: rcs0
[336.253917] Dynamic subtest rcs0: SUCCESS (0.829s)
[336.270164] Starting dynamic subtest: bcs0
[337.056481] Dynamic subtest bcs0: SUCCESS (0.800s)
[337.071526] Starting dynamic subtest: vcs0
[337.845127] Dynamic subtest vcs0: SUCCESS (0.786s)
[337.859761] Starting dynamic subtest: vcs1
[338.639142] Dynamic subtest vcs1: SUCCESS (0.791s)
[338.653167] Starting dynamic subtest: vecs0
[339.419113] Dynamic subtest vecs0: SUCCESS (0.777s)
[339.420740] Subtest saturated-hostile-nopreempt: SUCCESS (3.996s)
[339.606541] [070/133] (696s left) gem_exec_big (single)
[339.657298] Starting subtest: single
[346.953090] Subtest single: SUCCESS (7.292s)
[347.808968] [071/133] (688s left) gem_exec_fence (submit67)
[348.036975] Starting subtest: submit67
[348.040092] Subtest submit67: SKIP (0.000s)
[348.648834] [072/133] (687s left) kms_frontbuffer_tracking (psr-2p-scndscrn-shrfb-pgflip-blt)
[350.149378] Starting subtest: psr-2p-scndscrn-shrfb-pgflip-blt
[350.152671] Subtest psr-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s)
[350.382614] [073/133] (685s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-mmap-wc)
[351.875081] Starting subtest: fbc-rgb101010-draw-mmap-wc
[351.878836] Subtest fbc-rgb101010-draw-mmap-wc: SKIP (0.000s)
[352.135853] [074/133] (684s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-mmap-gtt)
[353.646280] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-mmap-gtt
[353.649823] Subtest fbc-1p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[353.848634] [075/133] (682s left) i915_drm_fdinfo (busy-idle)
[353.899829] Starting subtest: busy-idle
[353.901416] Starting dynamic subtest: rcs0
[353.904450] Dynamic subtest rcs0: SKIP (0.000s)
[353.917251] Starting dynamic subtest: bcs0
[353.920741] Dynamic subtest bcs0: SKIP (0.001s)
[353.933390] Starting dynamic subtest: vcs0
[353.936849] Dynamic subtest vcs0: SKIP (0.000s)
[353.949231] Starting dynamic subtest: vcs1
[353.952655] Dynamic subtest vcs1: SKIP (0.000s)
[353.964754] Starting dynamic subtest: vecs0
[353.968492] Dynamic subtest vecs0: SKIP (0.000s)
[353.971574] Subtest busy-idle: SKIP (0.009s)
[354.035174] [076/133] (682s left) kms_psr (psr2-primary-page-flip)
[355.522700] Subtest psr2-primary-page-flip: SKIP (0.000s)
[355.713422] [077/133] (680s left) kms_cursor_legacy (cursora-vs-flipb-atomic)
[357.201443] Starting subtest: cursorA-vs-flipB-atomic
[357.204540] Subtest cursorA-vs-flipB-atomic: SKIP (0.002s)
[357.392240] [078/133] (679s left) kms_prop_blob (blob-prop-lifetime)
[357.439002] Starting subtest: blob-prop-lifetime
[357.440522] Subtest blob-prop-lifetime: SUCCESS (0.001s)
[357.640751] [079/133] (679s left) kms_plane_scaling (plane-scaler-with-clipping-clamping-pixel-formats)
[359.126284] Starting subtest: plane-scaler-with-clipping-clamping-pixel-formats
[359.127665] Starting dynamic subtest: pipe-A
[361.634035] Dynamic subtest pipe-A: SUCCESS (2.508s)
[361.647784] Starting dynamic subtest: pipe-B
[363.939798] Dynamic subtest pipe-B: SUCCESS (2.304s)
[363.952599] Starting dynamic subtest: pipe-C
[364.229857] Dynamic subtest pipe-C: SUCCESS (0.289s)
[364.242635] Starting dynamic subtest: pipe-D
[364.519791] Dynamic subtest pipe-D: SUCCESS (0.289s)
[364.521534] Subtest plane-scaler-with-clipping-clamping-pixel-formats: SUCCESS (5.396s)
[364.744855] [080/133] (672s left) kms_pipe_crc_basic (hang-read-crc)
[366.469509] Starting subtest: hang-read-crc
[366.470982] Starting dynamic subtest: pipe-A-HDMI-A-1
[367.970566] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (1.501s)
[367.985520] Starting dynamic subtest: pipe-B-HDMI-A-1
[369.232681] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (1.259s)
[369.249646] Starting dynamic subtest: pipe-C-HDMI-A-1
[370.407463] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (1.172s)
[370.423111] Starting dynamic subtest: pipe-D-HDMI-A-1
[371.492919] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (1.082s)
[371.501726] Subtest hang-read-crc: SUCCESS (5.029s)
[371.767137] [081/133] (665s left) kms_selftest (drm_format)
[371.835891] Starting subtest: drm_format
[371.910833] Starting dynamic subtest: drm_test_format_block_width_invalid
[371.957491] Dynamic subtest drm_test_format_block_width_invalid: SUCCESS (0.109s)
[372.009638] Starting dynamic subtest: drm_test_format_block_width_one_plane
[372.048527] Dynamic subtest drm_test_format_block_width_one_plane: SUCCESS (0.083s)
[372.067366] Starting dynamic subtest: drm_test_format_block_width_two_plane
[372.139190] Dynamic subtest drm_test_format_block_width_two_plane: SUCCESS (0.086s)
[372.190092] Starting dynamic subtest: drm_test_format_block_width_three_plane
[372.244376] Dynamic subtest drm_test_format_block_width_three_plane: SUCCESS (0.098s)
[372.289370] Starting dynamic subtest: drm_test_format_block_width_tiled
[372.335216] Dynamic subtest drm_test_format_block_width_tiled: SUCCESS (0.087s)
[372.382358] Starting dynamic subtest: drm_test_format_block_height_invalid
[372.416174] Dynamic subtest drm_test_format_block_height_invalid: SUCCESS (0.076s)
[372.441141] Starting dynamic subtest: drm_test_format_block_height_one_plane
[372.495779] Dynamic subtest drm_test_format_block_height_one_plane: SUCCESS (0.076s)
[372.511919] Starting dynamic subtest: drm_test_format_block_height_two_plane
[372.585025] Dynamic subtest drm_test_format_block_height_two_plane: SUCCESS (0.082s)
[372.634734] Starting dynamic subtest: drm_test_format_block_height_three_plane
[372.670036] Dynamic subtest drm_test_format_block_height_three_plane: SUCCESS (0.079s)
[372.690467] Starting dynamic subtest: drm_test_format_block_height_tiled
[372.763063] Dynamic subtest drm_test_format_block_height_tiled: SUCCESS (0.088s)
[372.810837] Starting dynamic subtest: drm_test_format_min_pitch_invalid
[372.849205] Dynamic subtest drm_test_format_min_pitch_invalid: SUCCESS (0.080s)
[372.872512] Starting dynamic subtest: drm_test_format_min_pitch_one_plane_8bpp
[372.939111] Dynamic subtest drm_test_format_min_pitch_one_plane_8bpp: SUCCESS (0.084s)
[372.989679] Starting dynamic subtest: drm_test_format_min_pitch_one_plane_16bpp
[373.025703] Dynamic subtest drm_test_format_min_pitch_one_plane_16bpp: SUCCESS (0.082s)
[373.049966] Starting dynamic subtest: drm_test_format_min_pitch_one_plane_24bpp
[373.120998] Dynamic subtest drm_test_format_min_pitch_one_plane_24bpp: SUCCESS (0.092s)
[373.170268] Starting dynamic subtest: drm_test_format_min_pitch_one_plane_32bpp
[373.208487] Dynamic subtest drm_test_format_min_pitch_one_plane_32bpp: SUCCESS (0.079s)
[373.229167] Starting dynamic subtest: drm_test_format_min_pitch_two_plane
[373.286542] Dynamic subtest drm_test_format_min_pitch_two_plane: SUCCESS (0.073s)
[373.335438] Starting dynamic subtest: drm_test_format_min_pitch_three_plane_8bpp
[373.369404] Dynamic subtest drm_test_format_min_pitch_three_plane_8bpp: SUCCESS (0.078s)
[373.392160] Starting dynamic subtest: drm_test_format_min_pitch_tiled
[373.461546] Dynamic subtest drm_test_format_min_pitch_tiled: SUCCESS (0.087s)
[373.464330] Subtest drm_format: SUCCESS (1.626s)
[373.706283] [082/133] (663s left) gem_close_race (multigpu-basic-process)
[373.779168] Starting subtest: multigpu-basic-process
[373.782992] Subtest multigpu-basic-process: SKIP (0.000s)
[374.161029] [083/133] (663s left) gem_set_tiling_vs_gtt
[374.283883] [084/133] (663s left) kms_plane_scaling (planes-downscale-factor-0-5-unity-scaling)
[375.768752] Starting subtest: planes-downscale-factor-0-5-unity-scaling
[375.770410] Starting dynamic subtest: pipe-A
[375.926844] Dynamic subtest pipe-A: SUCCESS (0.159s)
[375.953379] Starting dynamic subtest: pipe-B
[376.099974] Dynamic subtest pipe-B: SUCCESS (0.171s)
[376.113059] Starting dynamic subtest: pipe-C
[376.240736] Dynamic subtest pipe-C: SUCCESS (0.139s)
[376.253592] Starting dynamic subtest: pipe-D
[376.381032] Dynamic subtest pipe-D: SUCCESS (0.139s)
[376.382567] Subtest planes-downscale-factor-0-5-unity-scaling: SUCCESS (0.615s)
[376.611567] [085/133] (660s left) kms_addfb_basic (basic-y-tiled-legacy)
[376.660748] Starting subtest: basic-y-tiled-legacy
[376.664201] Subtest basic-y-tiled-legacy: SKIP (0.000s)
[378.360620] [086/133] (659s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0)
[379.866267] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0
[381.172150] Subtest x-tiled-max-hw-stride-32bpp-rotate-0: SUCCESS (1.305s)
[381.434412] [087/133] (656s left) gem_render_copy (y-tiled-mc-ccs-to-yf-tiled-ccs)
[381.492076] Starting subtest: y-tiled-mc-ccs-to-yf-tiled-ccs
[381.493791] Starting dynamic subtest: smem
[381.587375] Dynamic subtest smem: SUCCESS (0.097s)
[381.602342] Starting dynamic subtest: lmem0
[382.699191] Dynamic subtest lmem0: SUCCESS (1.107s)
[382.700770] Subtest y-tiled-mc-ccs-to-yf-tiled-ccs: SUCCESS (1.207s)
[382.988129] [088/133] (654s left) gem_caching (writes)
[383.068985] Starting subtest: writes
[388.040616] Subtest writes: SUCCESS (4.975s)
[388.261141] [089/133] (649s left) syncobj_timeline (etime-multi-wait-for-submit-unsubmitted)
[388.310089] Starting subtest: etime-multi-wait-for-submit-unsubmitted
[388.416631] Subtest etime-multi-wait-for-submit-unsubmitted: SUCCESS (0.104s)
[388.613841] [090/133] (649s left) kms_flip (wf_vblank-ts-check)
[390.107730] Starting subtest: wf_vblank-ts-check
[390.111120] Starting dynamic subtest: A-HDMI-A1
[398.278954] Dynamic subtest A-HDMI-A1: SUCCESS (8.168s)
[398.296650] Starting dynamic subtest: B-HDMI-A1
[406.404704] Dynamic subtest B-HDMI-A1: SUCCESS (8.124s)
[406.421599] Starting dynamic subtest: C-HDMI-A1
[414.367098] Dynamic subtest C-HDMI-A1: SUCCESS (7.959s)
[414.380871] Starting dynamic subtest: D-HDMI-A1
[422.326752] Dynamic subtest D-HDMI-A1: SUCCESS (7.960s)
[422.330823] Subtest wf_vblank-ts-check: SUCCESS (32.226s)
[422.582070] [091/133] (615s left) gem_lmem_evict (dontneed-evict-race)
[427.019063] Starting subtest: dontneed-evict-race
[429.129568] Subtest dontneed-evict-race: SUCCESS (2.107s)
[431.138821] [FACT gem_lmem_evict (dontneed-evict-race)] deleted: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[431.139954] [FACT gem_lmem_evict (dontneed-evict-race)] deleted: kernel.kmod_is_loaded.i915: true
[431.143381] [092/133] (606s left) gem_mmap_gtt (medium-copy-odd)
[434.418920] Subtest medium-copy-odd: SKIP (0.000s)
[434.505059] [FACT gem_mmap_gtt (medium-copy-odd)] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[434.509044] [FACT gem_mmap_gtt (medium-copy-odd)] new: kernel.kmod_is_loaded.i915: true
[434.513202] [093/133] (603s left) kms_plane (pixel-format-4-tiled-dg2-mc-ccs-modifier)
[436.007534] Starting subtest: pixel-format-4-tiled-dg2-mc-ccs-modifier
[436.017123] Subtest pixel-format-4-tiled-dg2-mc-ccs-modifier: SKIP (0.000s)
[436.170428] [094/133] (602s left) kms_ccs (crc-sprite-planes-basic-4-tiled-dg2-rc-ccs-cc)
[437.657153] Starting subtest: crc-sprite-planes-basic-4-tiled-dg2-rc-ccs-cc
[437.658488] Starting dynamic subtest: pipe-A-HDMI-A-1
[437.692975] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.003s)
[437.704018] Starting dynamic subtest: pipe-B-HDMI-A-1
[437.739043] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.003s)
[437.750020] Starting dynamic subtest: pipe-C-HDMI-A-1
[437.786548] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.003s)
[437.798237] Starting dynamic subtest: pipe-D-HDMI-A-1
[437.844311] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.003s)
[437.846792] Subtest crc-sprite-planes-basic-4-tiled-dg2-rc-ccs-cc: SKIP (0.020s)
[437.946518] [095/133] (600s left) gem_exec_suspend (basic-s0)
[438.008234] Starting subtest: basic-S0
[438.009556] Starting dynamic subtest: smem
[457.970688] Dynamic subtest smem: SUCCESS (5.324s)
[457.982661] Starting dynamic subtest: lmem0
[477.949698] Dynamic subtest lmem0: SUCCESS (5.136s)
[477.951476] Subtest basic-S0: SUCCESS (10.463s)
[484.222683] [096/133] (560s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180)
[485.751315] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180
[485.753977] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180: SKIP (0.000s)
[485.925389] [097/133] (558s left) gem_mmap_offset (bad-extensions)
[485.972716] Starting subtest: bad-extensions
[485.974144] Subtest bad-extensions: SUCCESS (0.000s)
[486.147386] [098/133] (558s left) kms_cursor_legacy (2x-long-nonblocking-modeset-vs-cursor-atomic)
[488.526274] Starting subtest: 2x-long-nonblocking-modeset-vs-cursor-atomic
[488.529302] Subtest 2x-long-nonblocking-modeset-vs-cursor-atomic: SKIP (0.003s)
[488.674592] [099/133] (555s left) gem_mmap_gtt (cpuset-big-copy-odd)
[488.727997] Subtest cpuset-big-copy-odd: SKIP (0.000s)
[488.808880] [100/133] (555s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip)
[490.656950] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip
[490.661011] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip: SKIP (0.000s)
[490.891020] [101/133] (553s left) kms_psr (fbc-psr2-sprite-render)
[492.398193] Subtest fbc-psr2-sprite-render: SKIP (0.000s)
[492.486260] [102/133] (552s left) kms_frontbuffer_tracking (fbcpsr-1p-shrfb-fliptrack-mmap-gtt)
[494.000056] Starting subtest: fbcpsr-1p-shrfb-fliptrack-mmap-gtt
[494.003462] Subtest fbcpsr-1p-shrfb-fliptrack-mmap-gtt: SKIP (0.000s)
[494.235851] [103/133] (550s left) kms_ccs (crc-primary-basic-y-tiled-ccs)
[495.731220] Starting subtest: crc-primary-basic-y-tiled-ccs
[495.734929] Starting dynamic subtest: pipe-A-HDMI-A-1
[495.750049] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.001s)
[495.762519] Starting dynamic subtest: pipe-B-HDMI-A-1
[495.778043] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.001s)
[495.789816] Starting dynamic subtest: pipe-C-HDMI-A-1
[495.805548] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.001s)
[495.817560] Starting dynamic subtest: pipe-D-HDMI-A-1
[495.834903] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.001s)
[495.838207] Subtest crc-primary-basic-y-tiled-ccs: SKIP (0.013s)
[496.003723] [104/133] (549s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite)
[497.507807] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite
[497.511554] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[497.747977] [105/133] (547s left) api_intel_bb (add-remove-objects)
[497.795774] Starting subtest: add-remove-objects
[497.816494] Subtest add-remove-objects: SUCCESS (0.021s)
[498.051468] [106/133] (547s left) sysfs_heartbeat_interval (nopreempt)
[498.110288] Starting subtest: nopreempt
[498.111641] Starting dynamic subtest: vecs0
[502.200955] Dynamic subtest vecs0: SUCCESS (4.068s)
[502.214333] Starting dynamic subtest: vcs0
[506.214998] Dynamic subtest vcs0: SUCCESS (4.001s)
[506.228147] Starting dynamic subtest: bcs0
[510.214846] Dynamic subtest bcs0: SUCCESS (3.990s)
[510.228618] Starting dynamic subtest: rcs0
[514.294390] Dynamic subtest rcs0: SUCCESS (4.072s)
[514.307867] Starting dynamic subtest: vcs1
[518.320042] Dynamic subtest vcs1: SUCCESS (4.022s)
[518.321592] Subtest nopreempt: SUCCESS (20.160s)
[518.535991] [107/133] (526s left) kms_getfb (getfb2-into-addfb2)
[520.028526] Starting subtest: getfb2-into-addfb2
[520.030050] Subtest getfb2-into-addfb2: SUCCESS (0.000s)
[520.271687] [108/133] (525s left) gem_close (basic)
[520.322684] Starting subtest: basic
[520.324378] Subtest basic: SUCCESS (0.000s)
[520.541144] [109/133] (525s left) gem_exec_schedule (preemptive-hang)
[520.714943] Starting subtest: preemptive-hang
[520.716614] Starting dynamic subtest: rcs0
[530.074779] Dynamic subtest rcs0: SUCCESS (9.351s)
[530.087557] Starting dynamic subtest: bcs0
[539.084361] Dynamic subtest bcs0: SUCCESS (9.016s)
[539.097682] Starting dynamic subtest: vcs0
[548.119533] Dynamic subtest vcs0: SUCCESS (9.030s)
[548.132747] Starting dynamic subtest: vcs1
[557.078904] Dynamic subtest vcs1: SUCCESS (8.955s)
[557.092430] Starting dynamic subtest: vecs0
[566.094659] Dynamic subtest vecs0: SUCCESS (9.010s)
[566.096271] Subtest preemptive-hang: SUCCESS (45.368s)
[566.455038] [110/133] (479s left) i915_drm_fdinfo (virtual-busy-idle)
[566.507761] Starting subtest: virtual-busy-idle
[566.511364] Subtest virtual-busy-idle: SKIP (0.000s)
[566.650925] [111/133] (479s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-mmap-wc)
[568.142678] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-mmap-wc
[568.146224] Subtest fbc-1p-offscreen-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[568.376200] [112/133] (477s left) gem_linear_blits (interruptible)
[568.640375] Starting subtest: interruptible
[577.020329] Subtest interruptible: SUCCESS (8.373s)
[577.239990] [113/133] (468s left) gem_ctx_persistence (engines-mixed)
[577.344119] Starting subtest: engines-mixed
[577.345880] Starting dynamic subtest: rcs0
[577.417439] Dynamic subtest rcs0: SUCCESS (0.073s)
[577.437962] Starting dynamic subtest: bcs0
[577.483965] Dynamic subtest bcs0: SUCCESS (0.064s)
[577.529754] Starting dynamic subtest: vcs0
[577.551449] Dynamic subtest vcs0: SUCCESS (0.063s)
[577.570895] Starting dynamic subtest: vcs1
[577.610601] Dynamic subtest vcs1: SUCCESS (0.057s)
[577.640121] Starting dynamic subtest: vecs0
[577.683858] Dynamic subtest vecs0: SUCCESS (0.070s)
[577.690587] Subtest engines-mixed: SUCCESS (0.342s)
[577.914304] [114/133] (468s left) perf_pmu (init-wait)
[577.964492] Starting subtest: init-wait
[577.965990] Starting dynamic subtest: rcs0
[577.967520] Dynamic subtest rcs0: SUCCESS (0.002s)
[577.981022] Starting dynamic subtest: bcs0
[577.982716] Dynamic subtest bcs0: SUCCESS (0.001s)
[577.996644] Starting dynamic subtest: vcs0
[577.998420] Dynamic subtest vcs0: SUCCESS (0.001s)
[578.011723] Starting dynamic subtest: vcs1
[578.013494] Dynamic subtest vcs1: SUCCESS (0.001s)
[578.026308] Starting dynamic subtest: vecs0
[578.027991] Dynamic subtest vecs0: SUCCESS (0.001s)
[578.029701] Subtest init-wait: SUCCESS (0.011s)
[578.101784] [115/133] (468s left) gem_exec_reloc (basic-gtt-cpu-active)
[578.156603] Subtest basic-gtt-cpu-active: SKIP (0.000s)
[578.277469] [116/133] (468s left) kms_pm_lpsp (screens-disabled)
[580.809378] Starting subtest: screens-disabled
[580.812574] Subtest screens-disabled: SKIP (0.000s)
[581.015682] [117/133] (465s left) kms_flip (flip-vs-expired-vblank-interruptible)
[582.505130] Starting subtest: flip-vs-expired-vblank-interruptible
[582.510676] Starting dynamic subtest: A-HDMI-A1
[590.277524] Dynamic subtest A-HDMI-A1: SUCCESS (7.769s)
[590.323508] Starting dynamic subtest: B-HDMI-A1
[597.986065] Dynamic subtest B-HDMI-A1: SUCCESS (7.701s)
[598.027960] Starting dynamic subtest: C-HDMI-A1
[605.676957] Dynamic subtest C-HDMI-A1: SUCCESS (7.685s)
[605.693599] Starting dynamic subtest: D-HDMI-A1
[613.338360] Dynamic subtest D-HDMI-A1: SUCCESS (7.660s)
[613.342008] Subtest flip-vs-expired-vblank-interruptible: SUCCESS (30.845s)
[613.633424] [118/133] (432s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-move)
[615.130671] Starting subtest: psr-1p-primscrn-cur-indfb-move
[615.134084] Subtest psr-1p-primscrn-cur-indfb-move: SKIP (0.000s)
[615.380846] [119/133] (431s left) kms_atomic_transition (plane-all-modeset-transition-internal-panels)
[616.867336] Starting subtest: plane-all-modeset-transition-internal-panels
[616.870373] Subtest plane-all-modeset-transition-internal-panels: SKIP (0.000s)
[617.081087] [120/133] (429s left) gem_userptr_blits (stress-mm)
[617.142369] Starting subtest: stress-mm
[622.514670] Subtest stress-mm: SUCCESS (5.369s)
[622.711570] [121/133] (424s left) syncobj_eventfd (invalid-bad-flags)
[622.780403] Starting subtest: invalid-bad-flags
[622.782151] Subtest invalid-bad-flags: SUCCESS (0.000s)
[622.986004] [122/133] (424s left) kms_addfb_basic (framebuffer-vs-set-tiling)
[623.034127] Starting subtest: framebuffer-vs-set-tiling
[623.037434] Subtest framebuffer-vs-set-tiling: SKIP (0.000s)
[624.717472] [123/133] (422s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-indfb-msflip-blt)
[626.208552] Starting subtest: fbc-2p-scndscrn-indfb-msflip-blt
[626.212108] Subtest fbc-2p-scndscrn-indfb-msflip-blt: SKIP (0.000s)
[626.407327] [124/133] (420s left) syncobj_timeline (multi-wait-for-submit-available-submitted-signaled)
[626.456604] Starting subtest: multi-wait-for-submit-available-submitted-signaled
[626.458205] Subtest multi-wait-for-submit-available-submitted-signaled: SUCCESS (0.001s)
[626.631123] [125/133] (420s left) kms_flip (2x-modeset-vs-vblank-race)
[628.118712] Starting subtest: 2x-modeset-vs-vblank-race
[628.136525] Subtest 2x-modeset-vs-vblank-race: SKIP (0.021s)
[628.358494] [126/133] (419s left) i915_query (query-regions-garbage-items)
[628.404487] Starting subtest: query-regions-garbage-items
[628.406227] Subtest query-regions-garbage-items: SUCCESS (0.000s)
[628.606998] [127/133] (419s left) kms_psr_stress_test (flip-primary-invalidate-overlay)
[628.654023] Subtest flip-primary-invalidate-overlay: SKIP (0.000s)
[628.743527] [128/133] (419s left) gem_exec_balancer (full-late)
[628.802296] Starting subtest: full-late
[631.190720] Subtest full-late: SUCCESS (2.388s)
[631.684692] [129/133] (416s left) gem_exec_reloc (basic-write-wc)
[631.734945] Subtest basic-write-wc: SKIP (0.000s)
[631.826696] [130/133] (416s left) kms_force_connector_basic (force-load-detect)
[631.978318] Starting subtest: force-load-detect
[631.981119] Subtest force-load-detect: SKIP (0.000s)
[632.974007] [131/133] (415s left) kms_chamelium_hpd (hdmi-hpd-fast)
[634.506448] Subtest hdmi-hpd-fast: SKIP (0.000s)
[634.624712] [132/133] (413s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-32bpp-xtile-upscaling)
[636.112471] Starting subtest: flip-64bpp-xtile-to-32bpp-xtile-upscaling
[636.113962] Starting dynamic subtest: pipe-A-valid-mode
[636.960473] Dynamic subtest pipe-A-valid-mode: SUCCESS (0.846s)
[636.961979] Subtest flip-64bpp-xtile-to-32bpp-xtile-upscaling: SUCCESS (0.849s)
[637.207006] [133/133] (410s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-mmap-cpu)
[638.701006] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-mmap-cpu
[638.706725] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[638.944208] Closing watchdogs
results: parsing output: 0/ for test: kms_content_protection
results: parsing output: 1/ for test: core_getversion
results: parsing output: 2/ for test: kms_atomic_interruptible
results: parsing output: 3/ for test: kms_plane
results: parsing output: 4/ for test: kms_atomic_transition
results: parsing output: 5/ for test: kms_frontbuffer_tracking
results: parsing output: 6/ for test: kms_psr
results: parsing output: 7/ for test: perf
results: parsing output: 8/ for test: gem_eio
results: parsing output: 9/ for test: kms_color
results: parsing output: 10/ for test: gem_softpin
results: parsing output: 11/ for test: kms_psr2_sf
results: parsing output: 12/ for test: kms_big_fb
results: parsing output: 13/ for test: kms_psr
results: parsing output: 14/ for test: kms_frontbuffer_tracking
results: parsing output: 15/ for test: kms_psr2_sf
results: parsing output: 16/ for test: gem_ccs
results: parsing output: 17/ for test: perf
results: parsing output: 18/ for test: kms_frontbuffer_tracking
results: parsing output: 19/ for test: gem_pxp
results: parsing output: 20/ for test: gem_eio
results: parsing output: 21/ for test: kms_frontbuffer_tracking
results: parsing output: 22/ for test: gem_exec_schedule
results: parsing output: 23/ for test: core_getstats
results: parsing output: 24/ for test: kms_ccs
results: parsing output: 25/ for test: kms_ccs
results: parsing output: 26/ for test: sw_sync
results: parsing output: 27/ for test: i915_pm_rps
results: parsing output: 28/ for test: kms_cursor_legacy
results: parsing output: 29/ for test: kms_cursor_crc
results: parsing output: 30/ for test: kms_dp_link_training
results: parsing output: 31/ for test: kms_frontbuffer_tracking
results: parsing output: 32/ for test: gem_exec_parallel
results: parsing output: 33/ for test: gem_eio
results: parsing output: 34/ for test: prime_mmap
results: parsing output: 35/ for test: kms_dsc
results: parsing output: 36/ for test: prime_busy
results: parsing output: 37/ for test: kms_vblank
results: parsing output: 38/ for test: kms_pm_rpm
results: parsing output: 39/ for test: kms_cursor_legacy
results: parsing output: 40/ for test: kms_frontbuffer_tracking
results: parsing output: 41/ for test: syncobj_timeline
results: parsing output: 42/ for test: perf
results: parsing output: 43/ for test: gem_wait
results: parsing output: 44/ for test: gen9_exec_parse
results: parsing output: 45/ for test: kms_cursor_edge_walk
results: parsing output: 46/ for test: kms_frontbuffer_tracking
results: parsing output: 47/ for test: prime_mmap
results: parsing output: 48/ for test: kms_addfb_basic
results: parsing output: 49/ for test: kms_chamelium_audio
results: parsing output: 50/ for test: kms_chamelium_edid
results: parsing output: 51/ for test: kms_frontbuffer_tracking
results: parsing output: 52/ for test: kms_flip_scaled_crc
results: parsing output: 53/ for test: perf
results: parsing output: 54/ for test: kms_joiner
results: parsing output: 55/ for test: kms_cursor_crc
results: parsing output: 56/ for test: kms_legacy_colorkey
results: parsing output: 57/ for test: kms_big_fb
results: parsing output: 58/ for test: kms_addfb_basic
results: parsing output: 59/ for test: gem_render_copy
results: parsing output: 60/ for test: gem_exec_reloc
results: parsing output: 61/ for test: kms_big_fb
results: parsing output: 62/ for test: syncobj_wait
results: parsing output: 63/ for test: kms_async_flips
results: parsing output: 64/ for test: kms_flip
results: parsing output: 65/ for test: kms_frontbuffer_tracking
results: parsing output: 66/ for test: syncobj_timeline
results: parsing output: 67/ for test: kms_big_fb
results: parsing output: 68/ for test: gem_ctx_persistence
results: parsing output: 69/ for test: gem_exec_big
results: parsing output: 70/ for test: gem_exec_fence
results: parsing output: 71/ for test: kms_frontbuffer_tracking
results: parsing output: 72/ for test: kms_frontbuffer_tracking
results: parsing output: 73/ for test: kms_frontbuffer_tracking
results: parsing output: 74/ for test: i915_drm_fdinfo
results: parsing output: 75/ for test: kms_psr
results: parsing output: 76/ for test: kms_cursor_legacy
results: parsing output: 77/ for test: kms_prop_blob
results: parsing output: 78/ for test: kms_plane_scaling
results: parsing output: 79/ for test: kms_pipe_crc_basic
results: parsing output: 80/ for test: kms_selftest
results: parsing output: 81/ for test: gem_close_race
results: parsing output: 82/ for test: gem_set_tiling_vs_gtt
results: parsing output: 83/ for test: kms_plane_scaling
results: parsing output: 84/ for test: kms_addfb_basic
results: parsing output: 85/ for test: kms_big_fb
results: parsing output: 86/ for test: gem_render_copy
results: parsing output: 87/ for test: gem_caching
results: parsing output: 88/ for test: syncobj_timeline
results: parsing output: 89/ for test: kms_flip
results: parsing output: 90/ for test: gem_lmem_evict
results: parsing output: 91/ for test: gem_mmap_gtt
results: parsing output: 92/ for test: kms_plane
results: parsing output: 93/ for test: kms_ccs
results: parsing output: 94/ for test: gem_exec_suspend
results: parsing output: 95/ for test: kms_big_fb
results: parsing output: 96/ for test: gem_mmap_offset
results: parsing output: 97/ for test: kms_cursor_legacy
results: parsing output: 98/ for test: gem_mmap_gtt
results: parsing output: 99/ for test: kms_big_fb
results: parsing output: 100/ for test: kms_psr
results: parsing output: 101/ for test: kms_frontbuffer_tracking
results: parsing output: 102/ for test: kms_ccs
results: parsing output: 103/ for test: kms_frontbuffer_tracking
results: parsing output: 104/ for test: api_intel_bb
results: parsing output: 105/ for test: sysfs_heartbeat_interval
results: parsing output: 106/ for test: kms_getfb
results: parsing output: 107/ for test: gem_close
results: parsing output: 108/ for test: gem_exec_schedule
results: parsing output: 109/ for test: i915_drm_fdinfo
results: parsing output: 110/ for test: kms_frontbuffer_tracking
results: parsing output: 111/ for test: gem_linear_blits
results: parsing output: 112/ for test: gem_ctx_persistence
results: parsing output: 113/ for test: perf_pmu
results: parsing output: 114/ for test: gem_exec_reloc
results: parsing output: 115/ for test: kms_pm_lpsp
results: parsing output: 116/ for test: kms_flip
results: parsing output: 117/ for test: kms_frontbuffer_tracking
results: parsing output: 118/ for test: kms_atomic_transition
results: parsing output: 119/ for test: gem_userptr_blits
results: parsing output: 120/ for test: syncobj_eventfd
results: parsing output: 121/ for test: kms_addfb_basic
results: parsing output: 122/ for test: kms_frontbuffer_tracking
results: parsing output: 123/ for test: syncobj_timeline
results: parsing output: 124/ for test: kms_flip
results: parsing output: 125/ for test: i915_query
results: parsing output: 126/ for test: kms_psr_stress_test
results: parsing output: 127/ for test: gem_exec_balancer
results: parsing output: 128/ for test: gem_exec_reloc
results: parsing output: 129/ for test: kms_force_connector_basic
results: parsing output: 130/ for test: kms_chamelium_hpd
results: parsing output: 131/ for test: kms_flip_scaled_crc
results: parsing output: 132/ for test: kms_frontbuffer_tracking
Done.