[71.236389] Initializing watchdogs
[71.236449]   /dev/watchdog0
[71.251695] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:9a49 Intel Tigerlake (Gen12) TigerLake-LP GT2 [Iris Xe Graphics]
[71.257463] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[71.260635] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[71.262459] [001/133] (960s left) kms_joiner (basic-force-big-joiner)
[71.354077] Starting subtest: basic-force-big-joiner
[71.355418] Subtest basic-force-big-joiner: SKIP (0.000s)
[71.409190] [002/133] (960s left) perf_pmu (busy-idle-check-all)
[71.447111] Starting subtest: busy-idle-check-all
[71.447825] Starting dynamic subtest: rcs0
[72.067595] Dynamic subtest rcs0: SUCCESS (0.620s)
[72.076077] Starting dynamic subtest: bcs0
[72.690259] Dynamic subtest bcs0: SUCCESS (0.622s)
[72.699176] Starting dynamic subtest: vcs0
[73.312977] Dynamic subtest vcs0: SUCCESS (0.622s)
[73.321355] Starting dynamic subtest: vcs1
[73.944276] Dynamic subtest vcs1: SUCCESS (0.631s)
[73.952826] Starting dynamic subtest: vecs0
[74.571217] Dynamic subtest vecs0: SUCCESS (0.627s)
[74.572173] Subtest busy-idle-check-all: SUCCESS (3.124s)
[74.640866] [003/133] (957s left) kms_ccs (bad-pixel-format-y-tiled-gen12-mc-ccs)
[74.727473] Starting subtest: bad-pixel-format-y-tiled-gen12-mc-ccs
[74.728176] Starting dynamic subtest: pipe-A-HDMI-A-1
[74.734812] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.000s)
[74.740366] Starting dynamic subtest: pipe-B-HDMI-A-1
[74.746949] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.000s)
[74.752284] Starting dynamic subtest: pipe-C-HDMI-A-1
[74.758860] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.000s)
[74.764095] Starting dynamic subtest: pipe-D-HDMI-A-1
[74.770916] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.000s)
[74.772237] Subtest bad-pixel-format-y-tiled-gen12-mc-ccs: SKIP (0.004s)
[74.965200] [004/133] (956s left) gem_softpin (evict-snoop)
[75.006744] Starting subtest: evict-snoop
[75.008335] Subtest evict-snoop: SKIP (0.000s)
[75.066490] [005/133] (956s left) kms_big_fb (4-tiled-addfb-size-offset-overflow)
[75.161292] Starting subtest: 4-tiled-addfb-size-offset-overflow
[75.162725] Subtest 4-tiled-addfb-size-offset-overflow: SKIP (0.000s)
[75.245404] [006/133] (956s left) kms_hdr (invalid-hdr)
[75.332350] Starting subtest: invalid-hdr
[75.334455] Subtest invalid-hdr: SKIP (0.001s)
[75.385378] [007/133] (956s left) kms_async_flips (test-cursor)
[75.468752] Starting subtest: test-cursor
[75.592387] Starting dynamic subtest: pipe-A-HDMI-A-1
[75.688472] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.096s)
[75.825186] Starting dynamic subtest: pipe-B-HDMI-A-1
[75.887979] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.070s)
[76.008809] Starting dynamic subtest: pipe-C-HDMI-A-1
[76.088757] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.087s)
[76.214216] Starting dynamic subtest: pipe-D-HDMI-A-1
[76.287460] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.080s)
[76.288210] Subtest test-cursor: SUCCESS (0.819s)
[76.525658] [008/133] (955s left) kms_ccs (ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc)
[76.615153] Starting subtest: ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc
[76.615851] Starting dynamic subtest: pipe-A-HDMI-A-1
[76.622456] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.000s)
[76.628064] Starting dynamic subtest: pipe-B-HDMI-A-1
[76.634703] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.000s)
[76.640196] Starting dynamic subtest: pipe-C-HDMI-A-1
[76.646790] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.000s)
[76.652240] Starting dynamic subtest: pipe-D-HDMI-A-1
[76.658976] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.000s)
[76.660327] Subtest ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc: SKIP (0.004s)
[76.841254] [009/133] (955s left) gem_exec_schedule (preempt-other-chain)
[76.889567] Starting subtest: preempt-other-chain
[76.890264] Starting dynamic subtest: rcs0
[76.933946] Dynamic subtest rcs0: SUCCESS (0.045s)
[76.940509] Starting dynamic subtest: bcs0
[76.976974] Dynamic subtest bcs0: SUCCESS (0.043s)
[76.983934] Starting dynamic subtest: vcs0
[77.016933] Dynamic subtest vcs0: SUCCESS (0.040s)
[77.023473] Starting dynamic subtest: vcs1
[77.057496] Dynamic subtest vcs1: SUCCESS (0.040s)
[77.063946] Starting dynamic subtest: vecs0
[77.097443] Dynamic subtest vecs0: SUCCESS (0.040s)
[77.098180] Subtest preempt-other-chain: SUCCESS (0.208s)
[77.395150] [010/133] (954s left) kms_chamelium_edid (dp-edid-read)
[77.534903] Subtest dp-edid-read: SKIP (0.000s)
[77.618573] [011/133] (954s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-mmap-gtt)
[77.712612] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-mmap-gtt
[77.714016] Subtest fbc-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[77.793545] [012/133] (954s left) kms_flip (2x-nonexisting-fb)
[77.876340] Starting subtest: 2x-nonexisting-fb
[77.885424] Subtest 2x-nonexisting-fb: SKIP (0.009s)
[77.946437] [013/133] (954s left) gen7_exec_parse (basic-allocation)
[77.982093] Subtest basic-allocation: SKIP (0.000s)
[78.024999] [014/133] (954s left) kms_psr (fbc-psr2-basic)
[78.110335] Subtest fbc-psr2-basic: SKIP (0.000s)
[78.149902] [015/133] (954s left) kms_draw_crc (draw-method-blt)
[78.234495] Starting subtest: draw-method-blt
[78.235321] Starting dynamic subtest: xrgb8888-untiled
[78.397366] Dynamic subtest xrgb8888-untiled: SUCCESS (0.162s)
[78.410725] Starting dynamic subtest: rgb565-untiled
[78.555798] Dynamic subtest rgb565-untiled: SUCCESS (0.158s)
[78.569152] Starting dynamic subtest: xrgb2101010-untiled
[78.714151] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.158s)
[78.727519] Starting dynamic subtest: xbgr16161616f-untiled
[78.880769] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.166s)
[78.894433] Starting dynamic subtest: xrgb8888-xtiled
[78.972481] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.091s)
[78.987573] Starting dynamic subtest: rgb565-xtiled
[79.055756] Dynamic subtest rgb565-xtiled: SUCCESS (0.083s)
[79.069482] Starting dynamic subtest: xrgb2101010-xtiled
[79.138952] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.083s)
[79.152528] Starting dynamic subtest: xbgr16161616f-xtiled
[79.238932] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.099s)
[79.252478] Starting dynamic subtest: xrgb8888-ytiled
[79.338991] Dynamic subtest xrgb8888-ytiled: SUCCESS (0.099s)
[79.352266] Starting dynamic subtest: rgb565-ytiled
[79.430902] Dynamic subtest rgb565-ytiled: SUCCESS (0.091s)
[79.444336] Starting dynamic subtest: xrgb2101010-ytiled
[79.522364] Dynamic subtest xrgb2101010-ytiled: SUCCESS (0.091s)
[79.535908] Starting dynamic subtest: xbgr16161616f-ytiled
[79.622494] Dynamic subtest xbgr16161616f-ytiled: SUCCESS (0.099s)
[79.623447] Subtest draw-method-blt: SUCCESS (1.388s)
[79.727725] [016/133] (952s left) syncobj_wait (single-wait-for-submit-unsubmitted)
[79.761404] Starting subtest: single-wait-for-submit-unsubmitted
[79.874008] Subtest single-wait-for-submit-unsubmitted: SUCCESS (0.107s)
[79.941996] [017/133] (952s left) kms_selftest (drm_cmdline_parser)
[79.975141] Starting subtest: drm_cmdline_parser
[79.986875] Starting dynamic subtest: drm_test_cmdline_force_d_only
[80.052428] Dynamic subtest drm_test_cmdline_force_d_only: SUCCESS (0.064s)
[80.066490] Starting dynamic subtest: drm_test_cmdline_force_D_only_dvi
[80.121940] Dynamic subtest drm_test_cmdline_force_D_only_dvi: SUCCESS (0.069s)
[80.136309] Starting dynamic subtest: drm_test_cmdline_force_D_only_hdmi
[80.187573] Dynamic subtest drm_test_cmdline_force_D_only_hdmi: SUCCESS (0.065s)
[80.201461] Starting dynamic subtest: drm_test_cmdline_force_D_only_not_digital
[80.260781] Dynamic subtest drm_test_cmdline_force_D_only_not_digital: SUCCESS (0.072s)
[80.274791] Starting dynamic subtest: drm_test_cmdline_force_e_only
[80.330372] Dynamic subtest drm_test_cmdline_force_e_only: SUCCESS (0.069s)
[80.344549] Starting dynamic subtest: drm_test_cmdline_res
[80.397570] Dynamic subtest drm_test_cmdline_res: SUCCESS (0.067s)
[80.411595] Starting dynamic subtest: drm_test_cmdline_res_vesa
[80.472578] Dynamic subtest drm_test_cmdline_res_vesa: SUCCESS (0.073s)
[80.486447] Starting dynamic subtest: drm_test_cmdline_res_vesa_rblank
[80.533438] Dynamic subtest drm_test_cmdline_res_vesa_rblank: SUCCESS (0.061s)
[80.546905] Starting dynamic subtest: drm_test_cmdline_res_rblank
[80.602494] Dynamic subtest drm_test_cmdline_res_rblank: SUCCESS (0.068s)
[80.616443] Starting dynamic subtest: drm_test_cmdline_res_bpp
[80.665812] Dynamic subtest drm_test_cmdline_res_bpp: SUCCESS (0.062s)
[80.679694] Starting dynamic subtest: drm_test_cmdline_res_refresh
[80.729486] Dynamic subtest drm_test_cmdline_res_refresh: SUCCESS (0.063s)
[80.743750] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh
[80.811567] Dynamic subtest drm_test_cmdline_res_bpp_refresh: SUCCESS (0.081s)
[80.820976] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_interlaced
[80.886054] Dynamic subtest drm_test_cmdline_res_bpp_refresh_interlaced: SUCCESS (0.072s)
[80.898414] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_margins
[80.948626] Dynamic subtest drm_test_cmdline_res_bpp_refresh_margins: SUCCESS (0.062s)
[80.962502] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_off
[81.014739] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_off: SUCCESS (0.066s)
[81.028774] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_on
[81.077820] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_on: SUCCESS (0.062s)
[81.089646] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_on_analog
[81.140420] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_on_analog: SUCCESS (0.063s)
[81.152523] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_on_digital
[81.201501] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_on_digital: SUCCESS (0.060s)
[81.213357] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_interlaced_margins_force_on
[81.270791] Dynamic subtest drm_test_cmdline_res_bpp_refresh_interlaced_margins_force_on: SUCCESS (0.067s)
[81.283040] Starting dynamic subtest: drm_test_cmdline_res_margins_force_on
[81.340965] Dynamic subtest drm_test_cmdline_res_margins_force_on: SUCCESS (0.069s)
[81.353173] Starting dynamic subtest: drm_test_cmdline_res_vesa_margins
[81.407879] Dynamic subtest drm_test_cmdline_res_vesa_margins: SUCCESS (0.066s)
[81.419979] Starting dynamic subtest: drm_test_cmdline_name
[81.472510] Dynamic subtest drm_test_cmdline_name: SUCCESS (0.065s)
[81.481694] Starting dynamic subtest: drm_test_cmdline_name_bpp
[81.540793] Dynamic subtest drm_test_cmdline_name_bpp: SUCCESS (0.066s)
[81.554940] Starting dynamic subtest: drm_test_cmdline_name_option
[81.603476] Dynamic subtest drm_test_cmdline_name_option: SUCCESS (0.063s)
[81.618044] Starting dynamic subtest: drm_test_cmdline_name_bpp_option
[81.669949] Dynamic subtest drm_test_cmdline_name_bpp_option: SUCCESS (0.065s)
[81.683982] Starting dynamic subtest: drm_test_cmdline_rotate_0
[81.735466] Dynamic subtest drm_test_cmdline_rotate_0: SUCCESS (0.064s)
[81.749221] Starting dynamic subtest: drm_test_cmdline_rotate_90
[81.800439] Dynamic subtest drm_test_cmdline_rotate_90: SUCCESS (0.064s)
[81.814291] Starting dynamic subtest: drm_test_cmdline_rotate_180
[81.863458] Dynamic subtest drm_test_cmdline_rotate_180: SUCCESS (0.063s)
[81.877216] Starting dynamic subtest: drm_test_cmdline_rotate_270
[81.930801] Dynamic subtest drm_test_cmdline_rotate_270: SUCCESS (0.066s)
[81.944618] Starting dynamic subtest: drm_test_cmdline_hmirror
[82.000844] Dynamic subtest drm_test_cmdline_hmirror: SUCCESS (0.069s)
[82.014909] Starting dynamic subtest: drm_test_cmdline_vmirror
[82.072477] Dynamic subtest drm_test_cmdline_vmirror: SUCCESS (0.071s)
[82.086767] Starting dynamic subtest: drm_test_cmdline_margin_options
[82.147825] Dynamic subtest drm_test_cmdline_margin_options: SUCCESS (0.074s)
[82.162878] Starting dynamic subtest: drm_test_cmdline_multiple_options
[82.221231] Dynamic subtest drm_test_cmdline_multiple_options: SUCCESS (0.073s)
[82.236669] Starting dynamic subtest: drm_test_cmdline_bpp_extra_and_option
[82.289943] Dynamic subtest drm_test_cmdline_bpp_extra_and_option: SUCCESS (0.067s)
[82.305234] Starting dynamic subtest: drm_test_cmdline_extra_and_option
[82.359864] Dynamic subtest drm_test_cmdline_extra_and_option: SUCCESS (0.070s)
[82.375644] Starting dynamic subtest: drm_test_cmdline_freestanding_options
[82.425471] Dynamic subtest drm_test_cmdline_freestanding_options: SUCCESS (0.064s)
[82.440805] Starting dynamic subtest: drm_test_cmdline_freestanding_force_e_and_options
[82.489674] Dynamic subtest drm_test_cmdline_freestanding_force_e_and_options: SUCCESS (0.064s)
[82.503951] Starting dynamic subtest: drm_test_cmdline_panel_orientation
[82.560371] Dynamic subtest drm_test_cmdline_panel_orientation: SUCCESS (0.069s)
[82.572782] Starting dynamic subtest: drm_test_cmdline_invalid
[82.643184] Dynamic subtest drm_test_cmdline_invalid: SUCCESS (0.082s)
[82.654938] Starting dynamic subtest: drm_test_cmdline_tv_options
[82.716057] Dynamic subtest drm_test_cmdline_tv_options: SUCCESS (0.072s)
[82.716920] Subtest drm_cmdline_parser: SUCCESS (2.740s)
[82.851211] [018/133] (949s left) i915_drm_fdinfo (all-busy-idle-check-all)
[82.885966] Starting subtest: all-busy-idle-check-all
[83.503379] Subtest all-busy-idle-check-all: SUCCESS (0.617s)
[83.578989] [019/133] (948s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-pwrite)
[83.669741] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-pwrite
[83.671154] Subtest psr-2p-scndscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[83.757228] [020/133] (948s left) kms_frontbuffer_tracking (fbc-2p-rte)
[83.845608] Starting subtest: fbc-2p-rte
[83.847055] Subtest fbc-2p-rte: SKIP (0.000s)
[83.939996] [021/133] (948s left) gem_softpin (allocator-evict)
[83.979591] Starting subtest: allocator-evict
[83.980295] Starting dynamic subtest: rcs0
[107.249724] Dynamic subtest rcs0: SUCCESS (23.270s)
[107.256328] Starting dynamic subtest: bcs0
[130.271362] Dynamic subtest bcs0: SUCCESS (23.021s)
[130.278100] Starting dynamic subtest: vcs0
[153.267494] Dynamic subtest vcs0: SUCCESS (22.996s)
[153.274737] Starting dynamic subtest: vcs1
[176.782437] Dynamic subtest vcs1: SUCCESS (23.515s)
[176.789267] Starting dynamic subtest: vecs0
[199.776780] Dynamic subtest vecs0: SUCCESS (22.994s)
[199.777484] Subtest allocator-evict: SUCCESS (115.798s)
[199.835760] [022/133] (832s left) kms_big_fb (y-tiled-64bpp-rotate-180)
[199.984366] Starting subtest: y-tiled-64bpp-rotate-180
[201.440702] Subtest y-tiled-64bpp-rotate-180: SUCCESS (1.456s)
[201.560783] [023/133] (830s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite)
[201.651533] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite
[201.652964] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[201.742727] [024/133] (830s left) i915_pm_rps (reset)
[201.781910] Starting subtest: reset
[206.346152] Subtest reset: SUCCESS (4.534s)
[206.418653] [025/133] (826s left) kms_cursor_legacy (torture-bo)
[206.509287] Starting subtest: torture-bo
[206.510006] Starting dynamic subtest: pipe-A
[212.061119] Dynamic subtest pipe-A: SUCCESS (5.511s)
[212.069571] Starting dynamic subtest: pipe-B
[217.535046] Dynamic subtest pipe-B: SUCCESS (5.506s)
[217.544092] Starting dynamic subtest: pipe-C
[223.043786] Dynamic subtest pipe-C: SUCCESS (5.517s)
[223.052109] Starting dynamic subtest: pipe-D
[228.623982] Dynamic subtest pipe-D: SUCCESS (5.546s)
[228.635406] Starting dynamic subtest: all-pipes
[234.121594] Dynamic subtest all-pipes: SUCCESS (5.497s)
[234.122517] Subtest torture-bo: SUCCESS (27.578s)
[234.181275] [026/133] (798s left) kms_plane (pixel-format-y-tiled-gen12-rc-ccs-cc-modifier-source-clamping)
[234.270281] Starting subtest: pixel-format-y-tiled-gen12-rc-ccs-cc-modifier-source-clamping
[234.286438] Starting dynamic subtest: pipe-A-plane-0
[234.495116] Dynamic subtest pipe-A-plane-0: SUCCESS (0.208s)
[234.509884] Starting dynamic subtest: pipe-A-plane-3
[234.661808] Dynamic subtest pipe-A-plane-3: SUCCESS (0.166s)
[234.673446] Starting dynamic subtest: pipe-A-plane-5
[234.828576] Dynamic subtest pipe-A-plane-5: SUCCESS (0.166s)
[234.979856] Starting dynamic subtest: pipe-B-plane-0
[235.157463] Dynamic subtest pipe-B-plane-0: SUCCESS (0.183s)
[235.171833] Starting dynamic subtest: pipe-B-plane-3
[235.324192] Dynamic subtest pipe-B-plane-3: SUCCESS (0.166s)
[235.338905] Starting dynamic subtest: pipe-B-plane-5
[235.490733] Dynamic subtest pipe-B-plane-5: SUCCESS (0.166s)
[235.556024] Subtest pixel-format-y-tiled-gen12-rc-ccs-cc-modifier-source-clamping: SUCCESS (1.286s)
[235.716666] [027/133] (796s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-16bpp-ytile-downscaling)
[235.806672] Starting subtest: flip-64bpp-ytile-to-16bpp-ytile-downscaling
[235.807418] Starting dynamic subtest: pipe-A-valid-mode
[236.759825] Dynamic subtest pipe-A-valid-mode: SUCCESS (0.952s)
[236.760548] Subtest flip-64bpp-ytile-to-16bpp-ytile-downscaling: SUCCESS (0.954s)
[236.910178] [028/133] (795s left) kms_plane_scaling (planes-unity-scaling-downscale-factor-0-5)
[237.006344] Starting subtest: planes-unity-scaling-downscale-factor-0-5
[237.007034] Starting dynamic subtest: pipe-A
[237.137407] Dynamic subtest pipe-A: SUCCESS (0.131s)
[237.151911] Starting dynamic subtest: pipe-B
[237.280584] Dynamic subtest pipe-B: SUCCESS (0.143s)
[237.290273] Starting dynamic subtest: pipe-C
[237.416585] Dynamic subtest pipe-C: SUCCESS (0.136s)
[237.423563] Starting dynamic subtest: pipe-D
[237.560728] Dynamic subtest pipe-D: SUCCESS (0.143s)
[237.561439] Subtest planes-unity-scaling-downscale-factor-0-5: SUCCESS (0.555s)
[237.738515] [029/133] (795s left) api_intel_allocator (fork-simple-stress-signal)
[237.773114] Starting subtest: fork-simple-stress-signal
[243.226638] Subtest fork-simple-stress-signal: SUCCESS (5.417s)
[243.302972] [030/133] (789s left) kms_properties (plane-properties-legacy)
[243.394641] Starting subtest: plane-properties-legacy
[243.396222] Starting dynamic subtest: pipe-A-HDMI-A-1
[243.631704] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.236s)
[243.639838] Starting dynamic subtest: pipe-B-HDMI-A-1
[243.921450] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.287s)
[243.931346] Starting dynamic subtest: pipe-C-HDMI-A-1
[244.208417] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.285s)
[244.215621] Starting dynamic subtest: pipe-D-HDMI-A-1
[244.500271] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.291s)
[244.500984] Subtest plane-properties-legacy: SUCCESS (1.106s)
[244.648870] [031/133] (788s left) kms_flip (2x-modeset-vs-vblank-race-interruptible)
[244.750506] Starting subtest: 2x-modeset-vs-vblank-race-interruptible
[244.760953] Subtest 2x-modeset-vs-vblank-race-interruptible: SKIP (0.009s)
[244.820946] [032/133] (788s left) dmabuf_sync_file (export-wait-after-attach)
[244.904485] Starting subtest: export-wait-after-attach
[244.906344] Subtest export-wait-after-attach: SUCCESS (0.001s)
[244.953323] [FACT dmabuf_sync_file (export-wait-after-attach)] new: kernel.kmod_is_loaded.vgem: true
[244.954940] [033/133] (787s left) gem_exec_parallel (engines)
[244.996567] Starting subtest: engines
[244.997256] Starting dynamic subtest: basic
[246.584318] Dynamic subtest basic: SUCCESS (1.588s)
[246.592235] Starting dynamic subtest: contexts
[249.990418] Dynamic subtest contexts: SUCCESS (3.397s)
[249.997139] Starting dynamic subtest: fds
[251.985321] Dynamic subtest fds: SUCCESS (2.003s)
[251.992366] Starting dynamic subtest: userptr
[253.671129] Dynamic subtest userptr: SUCCESS (1.685s)
[253.671843] Subtest engines: SUCCESS (8.676s)
[253.856656] [034/133] (779s left) kms_content_protection (dp-mst-type-1)
[253.956525] Starting subtest: dp-mst-type-1
[253.957878] Subtest dp-mst-type-1: SKIP (0.000s)
[254.062685] [035/133] (778s left) gem_render_copy (yf-tiled-to-vebox-y-tiled)
[254.101540] Starting subtest: yf-tiled-to-vebox-y-tiled
[254.102281] Starting dynamic subtest: smem
[254.203439] Dynamic subtest smem: SUCCESS (0.101s)
[254.204188] Subtest yf-tiled-to-vebox-y-tiled: SUCCESS (0.102s)
[254.379690] [036/133] (778s left) dumb_buffer (map-valid)
[254.412627] Starting subtest: map-valid
[254.413377] Subtest map-valid: SUCCESS (0.000s)
[254.500789] [037/133] (778s left) kms_flip (flip-vs-dpms-on-nop-interruptible)
[254.590517] Starting subtest: flip-vs-dpms-on-nop-interruptible
[254.592404] Starting dynamic subtest: A-HDMI-A1
[255.401490] Dynamic subtest A-HDMI-A1: SUCCESS (0.809s)
[255.413719] Starting dynamic subtest: B-HDMI-A1
[256.177646] Dynamic subtest B-HDMI-A1: SUCCESS (0.773s)
[256.193497] Starting dynamic subtest: C-HDMI-A1
[256.968058] Dynamic subtest C-HDMI-A1: SUCCESS (0.789s)
[256.978725] Starting dynamic subtest: D-HDMI-A1
[257.752199] Dynamic subtest D-HDMI-A1: SUCCESS (0.782s)
[257.756830] Subtest flip-vs-dpms-on-nop-interruptible: SUCCESS (3.167s)
[257.904096] [038/133] (775s left) kms_ccs (bad-aux-stride-4-tiled-mtl-mc-ccs)
[257.995659] Starting subtest: bad-aux-stride-4-tiled-mtl-mc-ccs
[257.996342] Starting dynamic subtest: pipe-A-HDMI-A-1
[258.002941] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.000s)
[258.010036] Starting dynamic subtest: pipe-B-HDMI-A-1
[258.016549] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.000s)
[258.023412] Starting dynamic subtest: pipe-C-HDMI-A-1
[258.029972] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.000s)
[258.036767] Starting dynamic subtest: pipe-D-HDMI-A-1
[258.043380] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.000s)
[258.044821] Subtest bad-aux-stride-4-tiled-mtl-mc-ccs: SKIP (0.006s)
[258.221674] [039/133] (774s left) gem_ctx_param (invalid-set-no-zeromap)
[258.256773] Starting subtest: invalid-set-no-zeromap
[258.257447] Subtest invalid-set-no-zeromap: SUCCESS (0.000s)
[258.312537] [040/133] (774s left) kms_vrr (lobf)
[258.396877] Starting subtest: lobf
[258.398279] Subtest lobf: SKIP (0.000s)
[258.451843] [041/133] (774s left) kms_cursor_legacy (cursora-vs-flipb-legacy)
[258.536852] Starting subtest: cursorA-vs-flipB-legacy
[258.539127] Subtest cursorA-vs-flipB-legacy: SKIP (0.001s)
[258.595092] [042/133] (774s left) kms_vrr (flip-dpms)
[258.680815] Starting subtest: flip-dpms
[258.682790] Subtest flip-dpms: SKIP (0.000s)
[258.746610] [043/133] (774s left) gem_exec_balancer (waits)
[258.787686] Starting subtest: waits
[265.731144] Subtest waits: SUCCESS (6.909s)
[265.879482] [044/133] (767s left) kms_pm_rpm (system-suspend-modeset)
[267.283793] Starting subtest: system-suspend-modeset
[287.139774] Subtest system-suspend-modeset: SUCCESS (4.837s)
[294.388388] [045/133] (746s left) gem_exec_params (dr4-dirt)
[294.428620] Starting subtest: DR4-dirt
[294.429357] Subtest DR4-dirt: SUCCESS (0.000s)
[294.513290] [046/133] (745s left) kms_color_pipeline (plane-lut1d-pre-ctm3x4)
[294.603107] Starting subtest: plane-lut1d-pre-ctm3x4
[294.690974] Starting dynamic subtest: pipe-A-plane-0
[294.790419] Dynamic subtest pipe-A-plane-0: SUCCESS (0.099s)
[294.806889] Starting dynamic subtest: pipe-A-plane-1
[294.881976] Dynamic subtest pipe-A-plane-1: SUCCESS (0.090s)
[294.897749] Starting dynamic subtest: pipe-A-plane-2
[294.973771] Dynamic subtest pipe-A-plane-2: SUCCESS (0.090s)
[295.191176] Starting dynamic subtest: pipe-B-plane-0
[295.261639] Dynamic subtest pipe-B-plane-0: SUCCESS (0.083s)
[295.273118] Starting dynamic subtest: pipe-B-plane-1
[295.345337] Dynamic subtest pipe-B-plane-1: SUCCESS (0.082s)
[295.360356] Starting dynamic subtest: pipe-B-plane-2
[295.437161] Dynamic subtest pipe-B-plane-2: SUCCESS (0.090s)
[295.650317] Starting dynamic subtest: pipe-C-plane-0
[295.724448] Dynamic subtest pipe-C-plane-0: SUCCESS (0.083s)
[295.738338] Starting dynamic subtest: pipe-C-plane-1
[295.824521] Dynamic subtest pipe-C-plane-1: SUCCESS (0.098s)
[295.838914] Starting dynamic subtest: pipe-C-plane-2
[295.924619] Dynamic subtest pipe-C-plane-2: SUCCESS (0.098s)
[296.130802] Starting dynamic subtest: pipe-D-plane-0
[296.215064] Dynamic subtest pipe-D-plane-0: SUCCESS (0.092s)
[296.227197] Starting dynamic subtest: pipe-D-plane-1
[296.307148] Dynamic subtest pipe-D-plane-1: SUCCESS (0.090s)
[296.319672] Starting dynamic subtest: pipe-D-plane-2
[296.399589] Dynamic subtest pipe-D-plane-2: SUCCESS (0.090s)
[296.446869] Subtest plane-lut1d-pre-ctm3x4: SUCCESS (1.843s)
[296.567980] [047/133] (743s left) kms_plane_scaling (plane-downscale-factor-0-75-with-rotation)
[296.662650] Starting subtest: plane-downscale-factor-0-75-with-rotation
[296.663566] Starting dynamic subtest: pipe-A
[297.825493] Dynamic subtest pipe-A: SKIP (1.160s)
[297.837521] Starting dynamic subtest: pipe-B
[298.952520] Dynamic subtest pipe-B: SKIP (1.127s)
[298.960634] Starting dynamic subtest: pipe-C
[300.085733] Dynamic subtest pipe-C: SKIP (1.131s)
[300.093765] Starting dynamic subtest: pipe-D
[301.224127] Dynamic subtest pipe-D: SKIP (1.137s)
[301.225705] Subtest plane-downscale-factor-0-75-with-rotation: SKIP (4.559s)
[301.396485] [048/133] (739s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-blt)
[301.495238] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-blt
[301.496587] Subtest psr-2p-scndscrn-spr-indfb-draw-blt: SKIP (0.000s)
[301.593724] [049/133] (739s left) gem_render_copy (linear-to-vebox-yf-tiled)
[301.631863] Starting subtest: linear-to-vebox-yf-tiled
[301.632561] Starting dynamic subtest: smem
[301.699343] Dynamic subtest smem: SUCCESS (0.067s)
[301.700051] Subtest linear-to-vebox-yf-tiled: SUCCESS (0.068s)
[301.864172] [050/133] (738s left) kms_psr2_sf (fbc-psr2-cursor-plane-move-continuous-exceed-fully-sf)
[301.949615] Subtest fbc-psr2-cursor-plane-move-continuous-exceed-fully-sf: SKIP (0.000s)
[301.989935] [051/133] (738s left) kms_psr (fbc-psr-sprite-blt)
[302.076288] Subtest fbc-psr-sprite-blt: SKIP (0.000s)
[302.124845] [052/133] (738s left) gem_eio (kms)
[302.221888] Starting subtest: kms
[324.943870] Subtest kms: SUCCESS (22.719s)
[325.127455] [053/133] (715s left) kms_ccs (random-ccs-data-4-tiled-bmg-ccs)
[325.215776] Starting subtest: random-ccs-data-4-tiled-bmg-ccs
[325.217167] Subtest random-ccs-data-4-tiled-bmg-ccs: SKIP (0.000s)
[325.389957] [054/133] (715s left) syncobj_wait (single-wait-all-for-submit-submitted)
[325.425677] Starting subtest: single-wait-all-for-submit-submitted
[325.536295] Subtest single-wait-all-for-submit-submitted: SUCCESS (0.103s)
[325.601749] [055/133] (715s left) kms_flip_scaled_crc (flip-64bpp-linear-to-16bpp-linear-upscaling)
[325.686517] Starting subtest: flip-64bpp-linear-to-16bpp-linear-upscaling
[325.687221] Starting dynamic subtest: pipe-A-valid-mode
[326.467191] Dynamic subtest pipe-A-valid-mode: SUCCESS (0.780s)
[326.467914] Subtest flip-64bpp-linear-to-16bpp-linear-upscaling: SUCCESS (0.781s)
[326.588268] [056/133] (714s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-shrfb-pgflip-blt)
[326.681942] Starting subtest: fbcpsr-2p-scndscrn-shrfb-pgflip-blt
[326.683399] Subtest fbcpsr-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s)
[326.782259] [057/133] (714s left) syncobj_timeline (signal)
[326.817862] Starting subtest: signal
[326.818557] Subtest signal: SUCCESS (0.000s)
[326.886218] [058/133] (714s left) kms_big_fb (yf-tiled-64bpp-rotate-270)
[326.978619] Starting subtest: yf-tiled-64bpp-rotate-270
[326.980033] Subtest yf-tiled-64bpp-rotate-270: SKIP (0.000s)
[327.083590] [059/133] (713s left) gem_pread (uncached)
[327.117790] Starting subtest: uncached
[327.940483] Subtest uncached: SUCCESS (0.816s)
[328.010708] [060/133] (713s left) kms_flip (2x-flip-vs-wf_vblank)
[328.099932] Starting subtest: 2x-flip-vs-wf_vblank
[328.108681] Subtest 2x-flip-vs-wf_vblank: SKIP (0.009s)
[328.174707] [061/133] (712s left) kms_cursor_edge_walk (128x128-right-edge)
[328.258373] Starting subtest: 128x128-right-edge
[328.260142] Starting dynamic subtest: pipe-A-HDMI-A-1
[330.004207] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (1.742s)
[330.012395] Starting dynamic subtest: pipe-D-HDMI-A-1
[331.680348] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (1.675s)
[331.681104] Subtest 128x128-right-edge: SUCCESS (3.422s)
[331.786953] [062/133] (709s left) kms_chamelium_hpd (hdmi-hpd-after-suspend)
[331.931907] Subtest hdmi-hpd-after-suspend: SKIP (0.000s)
[332.023722] [063/133] (709s left) kms_cursor_legacy (2x-nonblocking-modeset-vs-cursor-atomic)
[332.113424] Starting subtest: 2x-nonblocking-modeset-vs-cursor-atomic
[332.115740] Subtest 2x-nonblocking-modeset-vs-cursor-atomic: SKIP (0.002s)
[332.173373] [064/133] (709s left) kms_big_fb (linear-16bpp-rotate-270)
[332.266051] Starting subtest: linear-16bpp-rotate-270
[332.345339] Subtest linear-16bpp-rotate-270: SKIP (0.078s)
[332.477717] [065/133] (708s left) i915_pciid
[332.579410] [066/133] (708s left) gem_ctx_param (invalid-param-get)
[332.611979] Starting subtest: invalid-param-get
[332.612698] Subtest invalid-param-get: SUCCESS (0.000s)
[332.680255] [067/133] (708s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-0-hflip)
[332.775518] Starting subtest: linear-max-hw-stride-32bpp-rotate-0-hflip
[332.776872] Subtest linear-max-hw-stride-32bpp-rotate-0-hflip: SKIP (0.000s)
[332.866548] [068/133] (708s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0-async-flip)
[332.961361] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0-async-flip
[333.287304] Subtest x-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SUCCESS (0.326s)
[333.424535] [069/133] (707s left) kms_chamelium_color (ctm-max)
[333.514278] Subtest ctm-max: SKIP (0.000s)
[333.560674] [070/133] (707s left) kms_psr (psr2-sprite-plane-onoff)
[333.645103] Subtest psr2-sprite-plane-onoff: SKIP (0.000s)
[333.687750] [071/133] (707s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-indfb-msflip-blt)
[333.775540] Starting subtest: fbc-2p-scndscrn-indfb-msflip-blt
[333.776906] Subtest fbc-2p-scndscrn-indfb-msflip-blt: SKIP (0.000s)
[333.868573] [072/133] (707s left) gem_exec_reloc (basic-gtt-read)
[333.906553] Starting subtest: basic-gtt-read
[333.913963] Subtest basic-gtt-read: SUCCESS (0.007s)
[334.022961] [073/133] (707s left) kms_psr2_sf (pr-overlay-plane-move-continuous-exceed-sf)
[334.108932] Subtest pr-overlay-plane-move-continuous-exceed-sf: SKIP (0.000s)
[334.154275] [074/133] (707s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-fullscreen)
[334.242178] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-fullscreen
[334.243525] Subtest fbcpsr-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s)
[334.331366] [075/133] (707s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-signaled)
[334.365592] Starting subtest: multi-wait-for-submit-available-unsubmitted-signaled
[334.366378] Subtest multi-wait-for-submit-available-unsubmitted-signaled: SUCCESS (0.001s)
[334.429480] [076/133] (707s left) prime_self_import (basic-with_fd_dup)
[334.461564] Starting subtest: basic-with_fd_dup
[334.464060] Subtest basic-with_fd_dup: SUCCESS (0.003s)
[334.565449] [077/133] (707s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-render)
[334.655283] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-render
[334.656623] Subtest fbc-2p-primscrn-pri-shrfb-draw-render: SKIP (0.000s)
[334.742058] [078/133] (707s left) perf_pmu (semaphore-wait)
[334.777659] Starting subtest: semaphore-wait
[334.778361] Starting dynamic subtest: rcs0
[335.295703] Dynamic subtest rcs0: SUCCESS (0.509s)
[335.306302] Starting dynamic subtest: bcs0
[335.800098] Dynamic subtest bcs0: SUCCESS (0.510s)
[335.811206] Starting dynamic subtest: vcs0
[336.319775] Dynamic subtest vcs0: SUCCESS (0.509s)
[336.330499] Starting dynamic subtest: vcs1
[336.831513] Dynamic subtest vcs1: SUCCESS (0.510s)
[336.842433] Starting dynamic subtest: vecs0
[337.343671] Dynamic subtest vecs0: SUCCESS (0.510s)
[337.344630] Subtest semaphore-wait: SUCCESS (2.558s)
[337.422364] [079/133] (704s left) gem_userptr_blits (sync-unmap)
[337.466829] Starting subtest: sync-unmap
[337.483490] Subtest sync-unmap: SUCCESS (0.017s)
[337.587174] [080/133] (704s left) gem_exec_schedule (smoketest-all)
[337.633167] Starting subtest: smoketest-all
[369.906571] Subtest smoketest-all: SUCCESS (32.257s)
[370.193291] [081/133] (671s left) syncobj_eventfd (timeline-wait)
[370.227676] Starting subtest: timeline-wait
[370.238622] Subtest timeline-wait: SUCCESS (0.011s)
[370.305701] [082/133] (671s left) gem_exec_flush (basic-wb-ro-before-default)
[370.347408] Starting subtest: basic-wb-ro-before-default
[375.777541] Subtest basic-wb-ro-before-default: SUCCESS (5.430s)
[375.994203] [083/133] (666s left) gem_exec_balancer (nop)
[376.034777] Starting subtest: nop
[414.290357] Subtest nop: SUCCESS (38.260s)
[414.479783] [084/133] (627s left) prime_mmap (test_aperture_limit)
[414.514970] Starting subtest: test_aperture_limit
[414.515710] Starting dynamic subtest: test_aperture_limit-smem
[414.525566] Dynamic subtest test_aperture_limit-smem: SUCCESS (0.011s)
[414.526353] Subtest test_aperture_limit: SUCCESS (0.012s)
[414.604346] [085/133] (627s left) syncobj_wait (invalid-signal-illegal-handle)
[414.638180] Starting subtest: invalid-signal-illegal-handle
[414.638857] Subtest invalid-signal-illegal-handle: SUCCESS (0.000s)
[414.706274] [086/133] (627s left) kms_frontbuffer_tracking (fbcpsr-farfromfence-mmap-gtt)
[414.796318] Starting subtest: fbcpsr-farfromfence-mmap-gtt
[414.797715] Subtest fbcpsr-farfromfence-mmap-gtt: SKIP (0.000s)
[414.893908] [087/133] (627s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-mmap-wc)
[414.982841] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-mmap-wc
[414.984291] Subtest fbc-2p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[415.065994] [088/133] (627s left) syncobj_timeline (etime-multi-wait-for-submit-submitted)
[415.099447] Starting subtest: etime-multi-wait-for-submit-submitted
[415.217332] Subtest etime-multi-wait-for-submit-submitted: SUCCESS (0.109s)
[415.284493] [089/133] (626s left) kms_plane_alpha_blend (alpha-basic)
[415.368910] Starting subtest: alpha-basic
[415.436862] Starting dynamic subtest: pipe-A-HDMI-A-1
[416.755893] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (1.318s)
[416.795631] Starting dynamic subtest: pipe-D-HDMI-A-1
[418.318008] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (1.534s)
[418.318810] Subtest alpha-basic: SUCCESS (2.951s)
[418.493781] [090/133] (623s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-mmap-gtt)
[418.593763] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-mmap-gtt
[418.595200] Subtest psr-2p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[418.695397] [091/133] (623s left) kms_cursor_crc (cursor-random-max-size)
[418.787271] Starting subtest: cursor-random-max-size
[418.789289] Subtest cursor-random-max-size: SKIP (0.000s)
[418.875971] [092/133] (623s left) gem_ctx_exec (basic-close-race)
[418.912888] Starting subtest: basic-close-race
[424.495100] Subtest basic-close-race: SUCCESS (5.548s)
[424.582001] [093/133] (617s left) gem_mmap_gtt (basic-write-read-distinct)
[424.615399] Starting subtest: basic-write-read-distinct
[424.617878] Subtest basic-write-read-distinct: SUCCESS (0.003s)
[424.721624] [094/133] (617s left) gem_ctx_persistence (many-contexts)
[424.759707] Starting subtest: many-contexts
[463.722217] Subtest many-contexts: SUCCESS (38.955s)
[463.792071] [095/133] (578s left) kms_rotation_crc (multiplane-rotation-cropping-top)
[463.879368] Starting subtest: multiplane-rotation-cropping-top
[490.124792] Subtest multiplane-rotation-cropping-top: SUCCESS (26.244s)
[490.236380] [096/133] (552s left) kms_flip (2x-busy-flip)
[490.332105] Starting subtest: 2x-busy-flip
[490.340334] Subtest 2x-busy-flip: SKIP (0.009s)
[490.419111] [097/133] (552s left) gem_exec_create (forked)
[490.460763] Starting subtest: forked
[490.461479] Starting dynamic subtest: smem
[510.555756] Dynamic subtest smem: SUCCESS (20.094s)
[510.556487] Subtest forked: SUCCESS (20.095s)
[510.745487] [098/133] (531s left) gem_lmem_swapping (random)
[510.783092] Subtest random: SKIP (0.000s)
[510.824278] [099/133] (531s left) syncobj_wait (invalid-reset-zero-handles)
[510.857782] Starting subtest: invalid-reset-zero-handles
[510.858502] Subtest invalid-reset-zero-handles: SUCCESS (0.000s)
[510.924570] [100/133] (531s left) kms_pm_dc (dc5-dpms-negative)
[512.015397] Starting subtest: dc5-dpms-negative
[516.261410] Subtest dc5-dpms-negative: SUCCESS (4.212s)
[516.296049] [101/133] (526s left) gem_exec_reloc (basic-cpu-wc-active)
[516.333698] Starting subtest: basic-cpu-wc-active
[516.465036] Subtest basic-cpu-wc-active: SUCCESS (0.122s)
[516.580014] [102/133] (526s left) gem_eio (suspend)
[516.622477] Starting subtest: suspend
[527.678310] Subtest suspend: SUCCESS (11.056s)
[536.816192] [103/133] (515s left) gem_eio (wait-10ms)
[536.867257] Starting subtest: wait-10ms
[537.030747] Subtest wait-10ms: SUCCESS (0.163s)
[537.145400] [104/133] (514s left) sysfs_heartbeat_interval (nopreempt)
[537.182651] Starting subtest: nopreempt
[537.184540] Starting dynamic subtest: vecs0
[540.763529] Dynamic subtest vecs0: SUCCESS (3.579s)
[540.777442] Starting dynamic subtest: vcs0
[544.371106] Dynamic subtest vcs0: SUCCESS (3.605s)
[544.382687] Starting dynamic subtest: bcs0
[547.975116] Dynamic subtest bcs0: SUCCESS (3.601s)
[547.986668] Starting dynamic subtest: rcs0
[551.612201] Dynamic subtest rcs0: SUCCESS (3.635s)
[551.621882] Starting dynamic subtest: vcs1
[555.197998] Dynamic subtest vcs1: SUCCESS (3.584s)
[555.199060] Subtest nopreempt: SUCCESS (18.016s)
[555.273143] [105/133] (496s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-onoff)
[555.365012] Starting subtest: fbc-1p-primscrn-spr-indfb-onoff
[556.802010] Subtest fbc-1p-primscrn-spr-indfb-onoff: SUCCESS (1.438s)
[556.941565] [106/133] (495s left) prime_vgem (basic-fence-read)
[557.012804] Starting subtest: basic-fence-read
[557.073460] Subtest basic-fence-read: SUCCESS (0.061s)
[557.177533] [107/133] (494s left) kms_addfb_basic (invalid-smem-bo-on-discrete)
[557.211272] Starting subtest: invalid-smem-bo-on-discrete
[557.212574] Subtest invalid-smem-bo-on-discrete: SKIP (0.000s)
[557.356556] [108/133] (494s left) kms_ccs (crc-primary-rotation-180-4-tiled-bmg-ccs)
[557.441438] Starting subtest: crc-primary-rotation-180-4-tiled-bmg-ccs
[557.442786] Subtest crc-primary-rotation-180-4-tiled-bmg-ccs: SKIP (0.000s)
[557.604685] [109/133] (494s left) kms_cursor_crc (cursor-dpms)
[557.691823] Starting subtest: cursor-dpms
[557.692537] Starting dynamic subtest: pipe-A-HDMI-A-1
[558.308488] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.616s)
[558.319708] Starting dynamic subtest: pipe-D-HDMI-A-1
[558.904005] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.591s)
[558.904793] Subtest cursor-dpms: SUCCESS (1.213s)
[559.054104] [110/133] (493s left) perf_pmu (interrupts-sync)
[559.092097] Starting subtest: interrupts-sync
[560.187783] Subtest interrupts-sync: SUCCESS (1.087s)
[560.290764] [111/133] (491s left) gem_exec_whisper (basic-contexts-forked)
[560.333523] Starting subtest: basic-contexts-forked
[563.013523] Subtest basic-contexts-forked: SUCCESS (2.671s)
[563.186123] [112/133] (489s left) kms_cursor_legacy (cursor-vs-flip-toggle)
[563.277418] Starting subtest: cursor-vs-flip-toggle
[595.219166] Subtest cursor-vs-flip-toggle: SUCCESS (31.942s)
[595.351328] [113/133] (456s left) syncobj_timeline (invalid-query-zero-handles)
[595.388639] Starting subtest: invalid-query-zero-handles
[595.389390] Subtest invalid-query-zero-handles: SUCCESS (0.000s)
[595.446495] [114/133] (456s left) gem_exec_schedule (u-fairslice-all)
[595.491282] Starting subtest: u-fairslice-all
[597.527124] Subtest u-fairslice-all: SUCCESS (2.037s)
[597.859912] [115/133] (454s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-mmap-cpu)
[597.950220] Starting subtest: psr-1p-primscrn-spr-indfb-draw-mmap-cpu
[597.951563] Subtest psr-1p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[598.050019] [116/133] (454s left) gen9_exec_parse (bb-start-out)
[598.086868] Subtest bb-start-out: SKIP (0.000s)
[598.137195] [117/133] (454s left) gem_exec_fence (syncobj-import)
[598.492906] Starting subtest: syncobj-import
[598.495397] Subtest syncobj-import: SUCCESS (0.003s)
[598.788238] [118/133] (453s left) kms_psr2_su (page_flip-nv12)
[598.821953] Subtest page_flip-NV12: SKIP (0.000s)
[598.866360] [119/133] (453s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-pgflip-blt)
[598.954479] Starting subtest: fbcpsr-1p-primscrn-indfb-pgflip-blt
[598.955852] Subtest fbcpsr-1p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[599.047854] [120/133] (453s left) gem_pwrite (basic-exhaustion)
[599.081817] Starting subtest: basic-exhaustion
[602.488128] Subtest basic-exhaustion: SUCCESS (3.398s)
[602.590005] [121/133] (449s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-onoff)
[602.681375] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-onoff
[602.682810] Subtest fbcpsr-2p-primscrn-cur-indfb-onoff: SKIP (0.000s)
[602.773190] [122/133] (449s left) kms_frontbuffer_tracking (fbcpsr-slowdraw)
[602.861733] Starting subtest: fbcpsr-slowdraw
[602.863176] Subtest fbcpsr-slowdraw: SKIP (0.000s)
[602.957457] [123/133] (449s left) gem_eio (in-flight-suspend)
[602.999389] Starting subtest: in-flight-suspend
[640.019459] Subtest in-flight-suspend: SUCCESS (7.509s)
[648.165701] [124/133] (412s left) gem_mmap_offset (bad-extensions)
[648.201937] Starting subtest: bad-extensions
[648.202622] Subtest bad-extensions: SUCCESS (0.000s)
[648.298789] [125/133] (412s left) kms_psr (pr-primary-render)
[648.385387] Subtest pr-primary-render: SKIP (0.000s)
[648.433845] [126/133] (412s left) gem_exec_flush (basic-uc-pro-default)
[648.474819] Starting subtest: basic-uc-pro-default
[653.917350] Subtest basic-uc-pro-default: SUCCESS (5.437s)
[654.130768] [127/133] (406s left) kms_plane_multiple (2x-tiling-yf)
[654.217848] Starting subtest: 2x-tiling-yf
[654.219281] Subtest 2x-tiling-yf: SKIP (0.000s)
[654.277877] [128/133] (406s left) api_intel_bb (intel-bb-blit-none)
[654.312523] Starting subtest: intel-bb-blit-none
[657.917682] Subtest intel-bb-blit-none: SUCCESS (3.570s)
[657.986897] [129/133] (402s left) kms_lease (multimaster-lease)
[658.074114] Starting subtest: multimaster-lease
[658.076520] Subtest multimaster-lease: SUCCESS (0.002s)
[658.138405] [130/133] (402s left) kms_frontbuffer_tracking (psr-slowdraw)
[658.230155] Starting subtest: psr-slowdraw
[658.231585] Subtest psr-slowdraw: SKIP (0.000s)
[658.306752] [131/133] (402s left) gem_lmem_swapping (heavy-verify-random)
[658.343059] Subtest heavy-verify-random: SKIP (0.000s)
[658.384580] [132/133] (402s left) syncobj_wait (invalid-multi-wait-unsubmitted-submitted-signaled)
[658.418479] Starting subtest: invalid-multi-wait-unsubmitted-submitted-signaled
[658.419162] Subtest invalid-multi-wait-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[658.497102] [133/133] (402s left) i915_suspend (forcewake)
[658.530593] Starting subtest: forcewake
[690.991205] Subtest forcewake: SUCCESS (2.386s)
[700.063306] Closing watchdogs
results: parsing output: 0/ for test: kms_joiner
results: parsing output: 1/ for test: perf_pmu
results: parsing output: 2/ for test: kms_ccs
results: parsing output: 3/ for test: gem_softpin
results: parsing output: 4/ for test: kms_big_fb
results: parsing output: 5/ for test: kms_hdr
results: parsing output: 6/ for test: kms_async_flips
results: parsing output: 7/ for test: kms_ccs
results: parsing output: 8/ for test: gem_exec_schedule
results: parsing output: 9/ for test: kms_chamelium_edid
results: parsing output: 10/ for test: kms_frontbuffer_tracking
results: parsing output: 11/ for test: kms_flip
results: parsing output: 12/ for test: gen7_exec_parse
results: parsing output: 13/ for test: kms_psr
results: parsing output: 14/ for test: kms_draw_crc
results: parsing output: 15/ for test: syncobj_wait
results: parsing output: 16/ for test: kms_selftest
results: parsing output: 17/ for test: i915_drm_fdinfo
results: parsing output: 18/ for test: kms_frontbuffer_tracking
results: parsing output: 19/ for test: kms_frontbuffer_tracking
results: parsing output: 20/ for test: gem_softpin
results: parsing output: 21/ for test: kms_big_fb
results: parsing output: 22/ for test: kms_frontbuffer_tracking
results: parsing output: 23/ for test: i915_pm_rps
results: parsing output: 24/ for test: kms_cursor_legacy
results: parsing output: 25/ for test: kms_plane
results: parsing output: 26/ for test: kms_flip_scaled_crc
results: parsing output: 27/ for test: kms_plane_scaling
results: parsing output: 28/ for test: api_intel_allocator
results: parsing output: 29/ for test: kms_properties
results: parsing output: 30/ for test: kms_flip
results: parsing output: 31/ for test: dmabuf_sync_file
results: parsing output: 32/ for test: gem_exec_parallel
results: parsing output: 33/ for test: kms_content_protection
results: parsing output: 34/ for test: gem_render_copy
results: parsing output: 35/ for test: dumb_buffer
results: parsing output: 36/ for test: kms_flip
results: parsing output: 37/ for test: kms_ccs
results: parsing output: 38/ for test: gem_ctx_param
results: parsing output: 39/ for test: kms_vrr
results: parsing output: 40/ for test: kms_cursor_legacy
results: parsing output: 41/ for test: kms_vrr
results: parsing output: 42/ for test: gem_exec_balancer
results: parsing output: 43/ for test: kms_pm_rpm
results: parsing output: 44/ for test: gem_exec_params
results: parsing output: 45/ for test: kms_color_pipeline
results: parsing output: 46/ for test: kms_plane_scaling
results: parsing output: 47/ for test: kms_frontbuffer_tracking
results: parsing output: 48/ for test: gem_render_copy
results: parsing output: 49/ for test: kms_psr2_sf
results: parsing output: 50/ for test: kms_psr
results: parsing output: 51/ for test: gem_eio
results: parsing output: 52/ for test: kms_ccs
results: parsing output: 53/ for test: syncobj_wait
results: parsing output: 54/ for test: kms_flip_scaled_crc
results: parsing output: 55/ for test: kms_frontbuffer_tracking
results: parsing output: 56/ for test: syncobj_timeline
results: parsing output: 57/ for test: kms_big_fb
results: parsing output: 58/ for test: gem_pread
results: parsing output: 59/ for test: kms_flip
results: parsing output: 60/ for test: kms_cursor_edge_walk
results: parsing output: 61/ for test: kms_chamelium_hpd
results: parsing output: 62/ for test: kms_cursor_legacy
results: parsing output: 63/ for test: kms_big_fb
results: parsing output: 64/ for test: i915_pciid
results: parsing output: 65/ for test: gem_ctx_param
results: parsing output: 66/ for test: kms_big_fb
results: parsing output: 67/ for test: kms_big_fb
results: parsing output: 68/ for test: kms_chamelium_color
results: parsing output: 69/ for test: kms_psr
results: parsing output: 70/ for test: kms_frontbuffer_tracking
results: parsing output: 71/ for test: gem_exec_reloc
results: parsing output: 72/ for test: kms_psr2_sf
results: parsing output: 73/ for test: kms_frontbuffer_tracking
results: parsing output: 74/ for test: syncobj_timeline
results: parsing output: 75/ for test: prime_self_import
results: parsing output: 76/ for test: kms_frontbuffer_tracking
results: parsing output: 77/ for test: perf_pmu
results: parsing output: 78/ for test: gem_userptr_blits
results: parsing output: 79/ for test: gem_exec_schedule
results: parsing output: 80/ for test: syncobj_eventfd
results: parsing output: 81/ for test: gem_exec_flush
results: parsing output: 82/ for test: gem_exec_balancer
results: parsing output: 83/ for test: prime_mmap
results: parsing output: 84/ for test: syncobj_wait
results: parsing output: 85/ for test: kms_frontbuffer_tracking
results: parsing output: 86/ for test: kms_frontbuffer_tracking
results: parsing output: 87/ for test: syncobj_timeline
results: parsing output: 88/ for test: kms_plane_alpha_blend
results: parsing output: 89/ for test: kms_frontbuffer_tracking
results: parsing output: 90/ for test: kms_cursor_crc
results: parsing output: 91/ for test: gem_ctx_exec
results: parsing output: 92/ for test: gem_mmap_gtt
results: parsing output: 93/ for test: gem_ctx_persistence
results: parsing output: 94/ for test: kms_rotation_crc
results: parsing output: 95/ for test: kms_flip
results: parsing output: 96/ for test: gem_exec_create
results: parsing output: 97/ for test: gem_lmem_swapping
results: parsing output: 98/ for test: syncobj_wait
results: parsing output: 99/ for test: kms_pm_dc
results: parsing output: 100/ for test: gem_exec_reloc
results: parsing output: 101/ for test: gem_eio
results: parsing output: 102/ for test: gem_eio
results: parsing output: 103/ for test: sysfs_heartbeat_interval
results: parsing output: 104/ for test: kms_frontbuffer_tracking
results: parsing output: 105/ for test: prime_vgem
results: parsing output: 106/ for test: kms_addfb_basic
results: parsing output: 107/ for test: kms_ccs
results: parsing output: 108/ for test: kms_cursor_crc
results: parsing output: 109/ for test: perf_pmu
results: parsing output: 110/ for test: gem_exec_whisper
results: parsing output: 111/ for test: kms_cursor_legacy
results: parsing output: 112/ for test: syncobj_timeline
results: parsing output: 113/ for test: gem_exec_schedule
results: parsing output: 114/ for test: kms_frontbuffer_tracking
results: parsing output: 115/ for test: gen9_exec_parse
results: parsing output: 116/ for test: gem_exec_fence
results: parsing output: 117/ for test: kms_psr2_su
results: parsing output: 118/ for test: kms_frontbuffer_tracking
results: parsing output: 119/ for test: gem_pwrite
results: parsing output: 120/ for test: kms_frontbuffer_tracking
results: parsing output: 121/ for test: kms_frontbuffer_tracking
results: parsing output: 122/ for test: gem_eio
results: parsing output: 123/ for test: gem_mmap_offset
results: parsing output: 124/ for test: kms_psr
results: parsing output: 125/ for test: gem_exec_flush
results: parsing output: 126/ for test: kms_plane_multiple
results: parsing output: 127/ for test: api_intel_bb
results: parsing output: 128/ for test: kms_lease
results: parsing output: 129/ for test: kms_frontbuffer_tracking
results: parsing output: 130/ for test: gem_lmem_swapping
results: parsing output: 131/ for test: syncobj_wait
results: parsing output: 132/ for test: i915_suspend
Done.