[57.996759] Initializing watchdogs
[57.996805]   /dev/watchdog0
[58.026044] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics]
[58.038717] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[58.044891] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[58.049187] [001/133] (960s left) kms_async_flips (invalid-async-flip-atomic)
[58.162646] Starting subtest: invalid-async-flip-atomic
[58.522387] Starting dynamic subtest: pipe-A-eDP-1
[59.359150] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.840s)
[59.723864] Starting dynamic subtest: pipe-B-eDP-1
[60.576638] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.864s)
[60.936281] Starting dynamic subtest: pipe-C-eDP-1
[61.707440] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.780s)
[62.067791] Starting dynamic subtest: pipe-D-eDP-1
[62.828482] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.767s)
[62.830917] Subtest invalid-async-flip-atomic: SUCCESS (4.683s)
[63.993715] [002/133] (954s left) gem_exec_flush (basic-wb-prw-default)
[64.063044] Starting subtest: basic-wb-prw-default
[69.515041] Subtest basic-wb-prw-default: SUCCESS (5.461s)
[69.777688] [003/133] (948s left) perf (gen8-unprivileged-single-ctx-counters)
[69.893761] Starting subtest: gen8-unprivileged-single-ctx-counters
[69.898229] Subtest gen8-unprivileged-single-ctx-counters: SKIP (0.000s)
[69.931507] [004/133] (948s left) gem_exec_fence (syncobj-wait)
[70.396702] Starting subtest: syncobj-wait
[71.927780] Subtest syncobj-wait: SUCCESS (1.530s)
[72.269221] [FACT gem_exec_fence (syncobj-wait)] new: kernel.kmod_is_loaded.vgem: true
[72.274726] [005/133] (946s left) kms_content_protection (type1)
[72.423792] Starting subtest: type1
[72.428308] Subtest type1: SKIP (0.000s)
[72.541965] [006/133] (946s left) kms_vblank (wait-idle)
[72.632750] Starting subtest: wait-idle
[72.634584] Starting dynamic subtest: pipe-A-eDP-1
[74.393114] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.762s)
[74.407884] Starting dynamic subtest: pipe-D-eDP-1
[76.803126] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.408s)
[76.805269] Subtest wait-idle: SUCCESS (4.173s)
[77.635116] [007/133] (941s left) kms_flip (2x-flip-vs-absolute-wf_vblank)
[77.731114] Starting subtest: 2x-flip-vs-absolute-wf_vblank
[77.738542] Subtest 2x-flip-vs-absolute-wf_vblank: SKIP (0.010s)
[77.814517] [008/133] (941s left) kms_chamelium_hpd (hdmi-hpd)
[78.214522] Subtest hdmi-hpd: SKIP (0.000s)
[79.043232] [009/133] (939s left) syncobj_timeline (etime-single-wait-all-available-unsubmitted)
[79.103084] Starting subtest: etime-single-wait-all-available-unsubmitted
[79.208815] Subtest etime-single-wait-all-available-unsubmitted: SUCCESS (0.105s)
[79.283551] [010/133] (939s left) kms_hdr (bpc-switch)
[79.389254] Starting subtest: bpc-switch
[80.437129] Starting dynamic subtest: pipe-A-eDP-1
[83.828966] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.392s)
[83.831183] Subtest bpc-switch: SUCCESS (4.439s)
[83.952626] [011/133] (935s left) gem_userptr_blits (unsync-unmap-after-close)
[84.026566] Subtest unsync-unmap-after-close: SKIP (0.000s)
[84.181588] [012/133] (934s left) perf_pmu (busy-accuracy-2)
[84.218677] Starting subtest: busy-accuracy-2
[84.221079] Starting dynamic subtest: rcs0
[87.263876] Dynamic subtest rcs0: SUCCESS (3.043s)
[87.274917] Starting dynamic subtest: bcs0
[90.322553] Dynamic subtest bcs0: SUCCESS (3.057s)
[90.332814] Starting dynamic subtest: vcs0
[93.371131] Dynamic subtest vcs0: SUCCESS (3.048s)
[93.382121] Starting dynamic subtest: vcs1
[96.419627] Dynamic subtest vcs1: SUCCESS (3.048s)
[96.429844] Starting dynamic subtest: vecs0
[99.467213] Dynamic subtest vecs0: SUCCESS (3.045s)
[99.477489] Starting dynamic subtest: ccs0
[102.525192] Dynamic subtest ccs0: SUCCESS (3.058s)
[102.527678] Subtest busy-accuracy-2: SUCCESS (18.302s)
[102.647884] [013/133] (916s left) kms_rotation_crc (multiplane-rotation-cropping-bottom)
[102.742636] Starting subtest: multiplane-rotation-cropping-bottom
[120.100864] Subtest multiplane-rotation-cropping-bottom: SUCCESS (17.360s)
[120.230057] [014/133] (898s left) kms_plane (plane-panning-top-left)
[120.314353] Starting subtest: plane-panning-top-left
[120.316169] Starting dynamic subtest: pipe-A
[121.964654] Dynamic subtest pipe-A: SUCCESS (1.648s)
[121.973911] Starting dynamic subtest: pipe-B
[124.209722] Dynamic subtest pipe-B: SUCCESS (2.245s)
[124.212058] Subtest plane-panning-top-left: SUCCESS (3.896s)
[125.021668] [015/133] (894s left) kms_dsc (dsc-with-output-formats-with-bpc)
[125.116084] Starting subtest: dsc-with-output-formats-with-bpc
[125.172706] Subtest dsc-with-output-formats-with-bpc: SKIP (0.001s)
[125.213922] [016/133] (893s left) kms_cursor_legacy (flip-vs-cursor-legacy)
[125.327418] Starting subtest: flip-vs-cursor-legacy
[132.833594] Subtest flip-vs-cursor-legacy: SUCCESS (7.504s)
[133.655206] [017/133] (885s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-mmap-cpu)
[133.763477] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-mmap-cpu
[140.414660] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-mmap-cpu: SUCCESS (6.653s)
[140.538586] [018/133] (878s left) kms_chamelium_frames (hdmi-cmp-planar-formats)
[140.928511] Subtest hdmi-cmp-planar-formats: SKIP (0.000s)
[141.696425] [019/133] (877s left) gem_exec_create (legacy)
[141.762636] Starting subtest: legacy
[141.764975] Starting dynamic subtest: smem
[144.916684] Dynamic subtest smem: SUCCESS (3.152s)
[144.919346] Subtest legacy: SUCCESS (3.153s)
[145.103526] [020/133] (874s left) gem_mmap_offset (open-flood)
[145.167124] Starting subtest: open-flood
[166.654208] Subtest open-flood: SUCCESS (21.488s)
[166.782083] [021/133] (852s left) kms_prop_blob (blob-prop-lifetime)
[166.832536] Starting subtest: blob-prop-lifetime
[166.834690] Subtest blob-prop-lifetime: SUCCESS (0.001s)
[166.928796] [022/133] (852s left) kms_pm_dc (dc9-dpms)
[168.039071] Starting subtest: dc9-dpms
[169.457334] Subtest dc9-dpms: SUCCESS (1.420s)
[169.527891] [023/133] (849s left) gem_ctx_shared (q-smoketest)
[169.598993] Starting subtest: Q-smoketest
[169.600902] Starting dynamic subtest: rcs0
[175.130372] Dynamic subtest rcs0: SUCCESS (5.483s)
[175.143957] Starting dynamic subtest: bcs0
[180.614128] Dynamic subtest bcs0: SUCCESS (5.489s)
[180.628407] Starting dynamic subtest: vcs0
[186.102959] Dynamic subtest vcs0: SUCCESS (5.485s)
[186.115436] Starting dynamic subtest: vcs1
[191.590563] Dynamic subtest vcs1: SUCCESS (5.488s)
[191.600399] Starting dynamic subtest: vecs0
[197.086656] Dynamic subtest vecs0: SUCCESS (5.492s)
[197.097385] Starting dynamic subtest: ccs0
[202.592980] Dynamic subtest ccs0: SUCCESS (5.502s)
[202.595157] Subtest Q-smoketest: SUCCESS (32.946s)
[202.770827] [024/133] (816s left) fbdev (unaligned-write)
[202.827273] Starting subtest: unaligned-write
[202.927800] Subtest unaligned-write: SUCCESS (0.100s)
[202.992937] [025/133] (816s left) kms_frontbuffer_tracking (psr-suspend)
[203.093204] Starting subtest: psr-suspend
[241.541300] Subtest psr-suspend: SUCCESS (8.008s)
[241.650593] [026/133] (777s left) kms_cursor_crc (cursor-random-max-size)
[241.957166] Starting subtest: cursor-random-max-size
[241.963470] Subtest cursor-random-max-size: SKIP (0.000s)
[242.080042] [027/133] (777s left) gem_render_copy (mixed-tiled-to-y-tiled-ccs)
[242.134664] Starting subtest: mixed-tiled-to-y-tiled-ccs
[242.138634] Subtest mixed-tiled-to-y-tiled-ccs: SKIP (0.000s)
[242.314797] [028/133] (777s left) kms_ccs (crc-sprite-planes-basic-y-tiled-gen12-rc-ccs)
[242.402038] Starting subtest: crc-sprite-planes-basic-y-tiled-gen12-rc-ccs
[242.404262] Starting dynamic subtest: pipe-A-eDP-1
[242.461777] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[242.472251] Starting dynamic subtest: pipe-B-eDP-1
[242.528582] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[242.538499] Starting dynamic subtest: pipe-C-eDP-1
[242.593550] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[242.603919] Starting dynamic subtest: pipe-D-eDP-1
[242.663691] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[242.667815] Subtest crc-sprite-planes-basic-y-tiled-gen12-rc-ccs: SKIP (0.008s)
[244.673885] [029/133] (775s left) kms_pm_rpm (package-g7)
[246.498890] Starting subtest: package-g7
[246.503920] Subtest package-g7: SKIP (0.000s)
[246.968202] [030/133] (772s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180)
[247.065500] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180
[248.047999] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180: SUCCESS (0.991s)
[248.170016] [031/133] (771s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted)
[248.223022] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted
[248.324569] Subtest etime-multi-wait-all-for-submit-available-unsubmitted: SUCCESS (0.102s)
[248.413682] [032/133] (771s left) perf (mi-rpc)
[248.520274] Starting subtest: mi-rpc
[248.525017] Subtest mi-rpc: SKIP (0.000s)
[248.564291] [033/133] (771s left) syncobj_basic (test-valid-cycle)
[248.614618] Starting subtest: test-valid-cycle
[248.616912] Subtest test-valid-cycle: SUCCESS (0.000s)
[248.709009] [034/133] (771s left) kms_cursor_crc (cursor-onscreen-256x256)
[248.973288] Starting subtest: cursor-onscreen-256x256
[248.975535] Starting dynamic subtest: pipe-A-eDP-1
[251.062117] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.101s)
[251.091870] Starting dynamic subtest: pipe-D-eDP-1
[253.804624] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.733s)
[253.807023] Subtest cursor-onscreen-256x256: SUCCESS (4.861s)
[254.670477] [035/133] (765s left) kms_addfb_basic (no-handle)
[254.737863] Starting subtest: no-handle
[254.740510] Subtest no-handle: SUCCESS (0.000s)
[254.900358] [036/133] (765s left) kms_flip (flip-vs-absolute-wf_vblank)
[254.989157] Starting subtest: flip-vs-absolute-wf_vblank
[254.991661] Starting dynamic subtest: A-eDP1
[263.901437] Dynamic subtest A-eDP1: SUCCESS (8.933s)
[263.912192] Starting dynamic subtest: B-eDP1
[272.813258] Dynamic subtest B-eDP1: SUCCESS (8.919s)
[272.824269] Starting dynamic subtest: C-eDP1
[281.737224] Dynamic subtest C-eDP1: SUCCESS (8.919s)
[281.746426] Starting dynamic subtest: D-eDP1
[290.664939] Dynamic subtest D-eDP1: SUCCESS (8.928s)
[290.666987] Subtest flip-vs-absolute-wf_vblank: SUCCESS (35.706s)
[291.884712] [037/133] (728s left) gem_fence_thrash (bo-copy)
[291.918282] Starting subtest: bo-copy
[291.932853] Subtest bo-copy: SKIP (0.012s)
[291.999954] [038/133] (728s left) gem_set_tiling_vs_blt (untiled-to-tiled)
[292.069700] Subtest untiled-to-tiled: SKIP (0.000s)
[292.150367] [039/133] (728s left) kms_atomic_transition (plane-primary-toggle-with-vblank-wait)
[292.244158] Starting subtest: plane-primary-toggle-with-vblank-wait
[292.246469] Starting dynamic subtest: pipe-A-eDP-1
[292.417390] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.174s)
[292.734860] Starting dynamic subtest: pipe-B-eDP-1
[293.590980] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.866s)
[293.887978] Subtest plane-primary-toggle-with-vblank-wait: SUCCESS (1.646s)
[294.765546] [040/133] (725s left) kms_cursor_edge_walk (256x256-top-edge)
[294.868488] Starting subtest: 256x256-top-edge
[294.870672] Starting dynamic subtest: pipe-A-eDP-1
[298.319217] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.451s)
[298.331997] Starting dynamic subtest: pipe-D-eDP-1
[301.440590] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.121s)
[301.442978] Subtest 256x256-top-edge: SUCCESS (6.575s)
[302.266620] [041/133] (718s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-move)
[302.364356] Starting subtest: fbc-1p-primscrn-cur-indfb-move
[306.420827] Subtest fbc-1p-primscrn-cur-indfb-move: SUCCESS (4.061s)
[307.564669] [042/133] (712s left) perf_pmu (invalid-open)
[307.605555] Starting subtest: invalid-open
[307.608005] Subtest invalid-open: SUCCESS (0.000s)
[307.731893] [043/133] (712s left) kms_cursor_legacy (flip-vs-cursor-toggle)
[307.846256] Starting subtest: flip-vs-cursor-toggle
[316.707868] Subtest flip-vs-cursor-toggle: SUCCESS (8.866s)
[317.576809] [044/133] (702s left) syncobj_timeline (single-wait-all-for-submit-signaled)
[317.629514] Starting subtest: single-wait-all-for-submit-signaled
[317.631924] Subtest single-wait-all-for-submit-signaled: SUCCESS (0.000s)
[317.727181] [045/133] (702s left) kms_psr (psr2-sprite-mmap-gtt)
[317.817511] Starting subtest: psr2-sprite-mmap-gtt
[317.819910] Starting dynamic subtest: eDP-1
[319.278839] Dynamic subtest eDP-1: SKIP (1.459s)
[319.283684] Subtest psr2-sprite-mmap-gtt: SKIP (1.461s)
[319.431665] [046/133] (701s left) kms_psr (fbc-pr-cursor-render)
[319.523473] Starting subtest: fbc-pr-cursor-render
[319.527707] Subtest fbc-pr-cursor-render: SKIP (0.000s)
[319.603979] [047/133] (700s left) prime_busy (before-wait)
[319.664986] Starting subtest: before-wait
[319.667285] Starting dynamic subtest: rcs0
[319.701105] Dynamic subtest rcs0: SUCCESS (0.035s)
[319.711609] Starting dynamic subtest: bcs0
[319.751661] Dynamic subtest bcs0: SUCCESS (0.050s)
[319.768476] Starting dynamic subtest: vcs0
[319.791811] Dynamic subtest vcs0: SUCCESS (0.040s)
[319.802517] Starting dynamic subtest: vcs1
[319.833504] Dynamic subtest vcs1: SUCCESS (0.041s)
[319.842507] Starting dynamic subtest: vecs0
[319.874491] Dynamic subtest vecs0: SUCCESS (0.040s)
[319.883594] Starting dynamic subtest: ccs0
[319.914297] Dynamic subtest ccs0: SUCCESS (0.039s)
[320.022270] Subtest before-wait: SUCCESS (0.358s)
[320.098325] [048/133] (700s left) i915_suspend (fence-restore-tiled2untiled)
[320.160785] Starting subtest: fence-restore-tiled2untiled
[320.164780] Subtest fence-restore-tiled2untiled: SKIP (0.000s)
[320.242036] [049/133] (700s left) kms_flip_scaled_crc (flip-64bpp-linear-to-16bpp-linear-upscaling)
[320.339332] Starting subtest: flip-64bpp-linear-to-16bpp-linear-upscaling
[320.341440] Starting dynamic subtest: pipe-A-default-mode
[323.031798] Dynamic subtest pipe-A-default-mode: SUCCESS (2.694s)
[323.034131] Subtest flip-64bpp-linear-to-16bpp-linear-upscaling: SUCCESS (2.695s)
[323.891128] [050/133] (696s left) kms_selftest (drm_cmdline_parser)
[323.933032] Starting subtest: drm_cmdline_parser
[323.987915] Starting dynamic subtest: drm_test_cmdline_force_d_only
[324.087682] Dynamic subtest drm_test_cmdline_force_d_only: SUCCESS (0.098s)
[324.099181] Starting dynamic subtest: drm_test_cmdline_force_D_only_dvi
[324.178284] Dynamic subtest drm_test_cmdline_force_D_only_dvi: SUCCESS (0.091s)
[324.188953] Starting dynamic subtest: drm_test_cmdline_force_D_only_hdmi
[324.278369] Dynamic subtest drm_test_cmdline_force_D_only_hdmi: SUCCESS (0.099s)
[324.288862] Starting dynamic subtest: drm_test_cmdline_force_D_only_not_digital
[324.368477] Dynamic subtest drm_test_cmdline_force_D_only_not_digital: SUCCESS (0.090s)
[324.378773] Starting dynamic subtest: drm_test_cmdline_force_e_only
[324.466469] Dynamic subtest drm_test_cmdline_force_e_only: SUCCESS (0.096s)
[324.474814] Starting dynamic subtest: drm_test_cmdline_res
[324.582251] Dynamic subtest drm_test_cmdline_res: SUCCESS (0.115s)
[324.590997] Starting dynamic subtest: drm_test_cmdline_res_vesa
[324.691343] Dynamic subtest drm_test_cmdline_res_vesa: SUCCESS (0.109s)
[324.700848] Starting dynamic subtest: drm_test_cmdline_res_vesa_rblank
[324.798468] Dynamic subtest drm_test_cmdline_res_vesa_rblank: SUCCESS (0.105s)
[324.808359] Starting dynamic subtest: drm_test_cmdline_res_rblank
[324.880123] Dynamic subtest drm_test_cmdline_res_rblank: SUCCESS (0.081s)
[324.888806] Starting dynamic subtest: drm_test_cmdline_res_bpp
[324.980093] Dynamic subtest drm_test_cmdline_res_bpp: SUCCESS (0.100s)
[324.988506] Starting dynamic subtest: drm_test_cmdline_res_refresh
[325.088351] Dynamic subtest drm_test_cmdline_res_refresh: SUCCESS (0.106s)
[325.096859] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh
[325.184319] Dynamic subtest drm_test_cmdline_res_bpp_refresh: SUCCESS (0.096s)
[325.193147] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_interlaced
[325.273673] Dynamic subtest drm_test_cmdline_res_bpp_refresh_interlaced: SUCCESS (0.090s)
[325.282013] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_margins
[325.371654] Dynamic subtest drm_test_cmdline_res_bpp_refresh_margins: SUCCESS (0.097s)
[325.380454] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_off
[325.470477] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_off: SUCCESS (0.095s)
[325.479461] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_on
[325.568642] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_on: SUCCESS (0.097s)
[325.577424] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_on_analog
[325.662872] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_on_analog: SUCCESS (0.096s)
[325.671289] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_on_digital
[325.758402] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_on_digital: SUCCESS (0.094s)
[325.766584] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_interlaced_margins_force_on
[325.868629] Dynamic subtest drm_test_cmdline_res_bpp_refresh_interlaced_margins_force_on: SUCCESS (0.109s)
[325.876864] Starting dynamic subtest: drm_test_cmdline_res_margins_force_on
[325.976134] Dynamic subtest drm_test_cmdline_res_margins_force_on: SUCCESS (0.107s)
[325.984660] Starting dynamic subtest: drm_test_cmdline_res_vesa_margins
[326.081791] Dynamic subtest drm_test_cmdline_res_vesa_margins: SUCCESS (0.105s)
[326.089942] Starting dynamic subtest: drm_test_cmdline_name
[326.161931] Dynamic subtest drm_test_cmdline_name: SUCCESS (0.079s)
[326.172182] Starting dynamic subtest: drm_test_cmdline_name_bpp
[326.258082] Dynamic subtest drm_test_cmdline_name_bpp: SUCCESS (0.093s)
[326.268369] Starting dynamic subtest: drm_test_cmdline_name_option
[326.349114] Dynamic subtest drm_test_cmdline_name_option: SUCCESS (0.090s)
[326.358471] Starting dynamic subtest: drm_test_cmdline_name_bpp_option
[326.453626] Dynamic subtest drm_test_cmdline_name_bpp_option: SUCCESS (0.105s)
[326.463309] Starting dynamic subtest: drm_test_cmdline_rotate_0
[326.556740] Dynamic subtest drm_test_cmdline_rotate_0: SUCCESS (0.102s)
[326.564924] Starting dynamic subtest: drm_test_cmdline_rotate_90
[326.656201] Dynamic subtest drm_test_cmdline_rotate_90: SUCCESS (0.100s)
[326.664476] Starting dynamic subtest: drm_test_cmdline_rotate_180
[326.760893] Dynamic subtest drm_test_cmdline_rotate_180: SUCCESS (0.103s)
[326.769173] Starting dynamic subtest: drm_test_cmdline_rotate_270
[326.864932] Dynamic subtest drm_test_cmdline_rotate_270: SUCCESS (0.103s)
[326.873321] Starting dynamic subtest: drm_test_cmdline_hmirror
[326.949151] Dynamic subtest drm_test_cmdline_hmirror: SUCCESS (0.083s)
[326.957991] Starting dynamic subtest: drm_test_cmdline_vmirror
[327.048828] Dynamic subtest drm_test_cmdline_vmirror: SUCCESS (0.100s)
[327.057327] Starting dynamic subtest: drm_test_cmdline_margin_options
[327.136838] Dynamic subtest drm_test_cmdline_margin_options: SUCCESS (0.088s)
[327.145254] Starting dynamic subtest: drm_test_cmdline_multiple_options
[327.223846] Dynamic subtest drm_test_cmdline_multiple_options: SUCCESS (0.086s)
[327.232191] Starting dynamic subtest: drm_test_cmdline_bpp_extra_and_option
[327.323647] Dynamic subtest drm_test_cmdline_bpp_extra_and_option: SUCCESS (0.099s)
[327.333767] Starting dynamic subtest: drm_test_cmdline_extra_and_option
[327.413868] Dynamic subtest drm_test_cmdline_extra_and_option: SUCCESS (0.090s)
[327.422149] Starting dynamic subtest: drm_test_cmdline_freestanding_options
[327.520562] Dynamic subtest drm_test_cmdline_freestanding_options: SUCCESS (0.105s)
[327.530398] Starting dynamic subtest: drm_test_cmdline_freestanding_force_e_and_options
[327.618621] Dynamic subtest drm_test_cmdline_freestanding_force_e_and_options: SUCCESS (0.098s)
[327.626639] Starting dynamic subtest: drm_test_cmdline_panel_orientation
[327.704237] Dynamic subtest drm_test_cmdline_panel_orientation: SUCCESS (0.085s)
[327.714122] Starting dynamic subtest: drm_test_cmdline_invalid
[327.804183] Dynamic subtest drm_test_cmdline_invalid: SUCCESS (0.100s)
[327.812451] Starting dynamic subtest: drm_test_cmdline_tv_options
[327.904524] Dynamic subtest drm_test_cmdline_tv_options: SUCCESS (0.101s)
[327.906432] Subtest drm_cmdline_parser: SUCCESS (3.977s)
[328.075156] [051/133] (692s left) i915_module_load (reload-no-display)
[328.106374] Starting subtest: reload-no-display
[332.433642] Subtest reload-no-display: SUCCESS (4.329s)
[332.462710] [FACT i915_module_load (reload-no-display)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[332.463430] [FACT i915_module_load (reload-no-display)] deleted: kernel.kmod_is_loaded.i915: true
[332.466723] [052/133] (688s left) gem_lmem_swapping (random)
[333.997175] Subtest random: SKIP (0.000s)
[334.056548] [FACT gem_lmem_swapping (random)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[334.057883] [FACT gem_lmem_swapping (random)] new: kernel.kmod_is_loaded.i915: true
[334.062150] [053/133] (686s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-render)
[334.176181] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-render
[340.955611] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-render: SUCCESS (6.780s)
[341.105282] [054/133] (679s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-plflip-blt)
[341.204791] Starting subtest: fbcpsr-1p-primscrn-indfb-plflip-blt
[348.685485] Subtest fbcpsr-1p-primscrn-indfb-plflip-blt: SUCCESS (7.480s)
[348.822774] [055/133] (672s left) gem_mmap_gtt (basic-read)
[348.880936] Subtest basic-read: SKIP (0.000s)
[348.938033] [056/133] (671s left) gem_softpin (evict-single-offset)
[348.993651] Starting subtest: evict-single-offset
[377.375334] Subtest evict-single-offset: SUCCESS (28.373s)
[377.514526] [057/133] (643s left) gem_exec_schedule (pi-userfault)
[377.749095] Starting subtest: pi-userfault
[377.751086] Starting dynamic subtest: rcs0
[377.762648] Dynamic subtest rcs0: SUCCESS (0.015s)
[377.774707] Starting dynamic subtest: bcs0
[377.777018] Dynamic subtest bcs0: SUCCESS (0.012s)
[377.789519] Starting dynamic subtest: vcs0
[377.791719] Dynamic subtest vcs0: SUCCESS (0.014s)
[377.803407] Starting dynamic subtest: vcs1
[377.805831] Dynamic subtest vcs1: SUCCESS (0.010s)
[377.814800] Starting dynamic subtest: vecs0
[377.817067] Dynamic subtest vecs0: SUCCESS (0.014s)
[377.827753] Starting dynamic subtest: ccs0
[377.829880] Dynamic subtest ccs0: SUCCESS (0.009s)
[377.832064] Subtest pi-userfault: SUCCESS (0.079s)
[378.025738] [058/133] (642s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-mc-ccs)
[378.115041] Starting subtest: crc-primary-suspend-4-tiled-dg2-mc-ccs
[378.117286] Starting dynamic subtest: pipe-A-eDP-1
[378.125917] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[378.135910] Starting dynamic subtest: pipe-B-eDP-1
[378.144714] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[378.153984] Starting dynamic subtest: pipe-C-eDP-1
[378.162120] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[378.170905] Starting dynamic subtest: pipe-D-eDP-1
[378.179098] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[378.183010] Subtest crc-primary-suspend-4-tiled-dg2-mc-ccs: SKIP (0.005s)
[380.315851] [059/133] (640s left) api_intel_bb (render-ccs)
[380.374579] Starting subtest: render-ccs
[380.728447] Subtest render-ccs: SUCCESS (0.354s)
[380.812259] [060/133] (640s left) kms_cursor_legacy (2x-long-flip-vs-cursor-atomic)
[380.927327] Starting subtest: 2x-long-flip-vs-cursor-atomic
[380.931760] Subtest 2x-long-flip-vs-cursor-atomic: SKIP (0.001s)
[381.083293] [061/133] (640s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-shrfb-pgflip-blt)
[381.190035] Starting subtest: fbc-2p-scndscrn-shrfb-pgflip-blt
[381.194255] Subtest fbc-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s)
[381.284816] [062/133] (639s left) kms_big_fb (4-tiled-8bpp-rotate-180)
[381.397451] Starting subtest: 4-tiled-8bpp-rotate-180
[382.543787] Subtest 4-tiled-8bpp-rotate-180: SUCCESS (1.147s)
[382.692040] [063/133] (638s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-0-hflip)
[382.788731] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-0-hflip
[382.792400] Subtest y-tiled-max-hw-stride-32bpp-rotate-0-hflip: SKIP (0.000s)
[382.878530] [064/133] (638s left) kms_plane_cursor (viewport)
[382.973891] Starting subtest: viewport
[382.977682] Starting dynamic subtest: pipe-A-eDP-1-size-64
[385.416655] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.443s)
[385.478686] Starting dynamic subtest: pipe-A-eDP-1-size-128
[387.928435] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.460s)
[387.994040] Starting dynamic subtest: pipe-A-eDP-1-size-256
[390.440751] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.460s)
[390.789592] Starting dynamic subtest: pipe-B-eDP-1-size-64
[393.972875] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.194s)
[394.033272] Starting dynamic subtest: pipe-B-eDP-1-size-128
[396.464662] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.440s)
[396.523571] Starting dynamic subtest: pipe-B-eDP-1-size-256
[398.930004] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.416s)
[399.284445] Starting dynamic subtest: pipe-C-eDP-1-size-64
[402.092001] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.818s)
[402.130895] Starting dynamic subtest: pipe-C-eDP-1-size-128
[404.202625] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.080s)
[404.241668] Starting dynamic subtest: pipe-C-eDP-1-size-256
[406.280713] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.047s)
[406.607282] Starting dynamic subtest: pipe-D-eDP-1-size-64
[409.334681] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (2.737s)
[409.372400] Starting dynamic subtest: pipe-D-eDP-1-size-128
[411.411340] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.047s)
[411.450793] Starting dynamic subtest: pipe-D-eDP-1-size-256
[413.555544] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.114s)
[413.879496] Subtest viewport: SUCCESS (30.907s)
[414.742713] [065/133] (606s left) gem_userptr_blits (readonly-unsync)
[414.809894] Subtest readonly-unsync: SKIP (0.000s)
[414.924199] [066/133] (606s left) kms_cursor_legacy (short-flip-before-cursor-atomic-transitions-varying-size)
[415.033806] Starting subtest: short-flip-before-cursor-atomic-transitions-varying-size
[415.984193] Subtest short-flip-before-cursor-atomic-transitions-varying-size: SUCCESS (0.949s)
[416.776702] [067/133] (604s left) kms_atomic_transition (plane-all-modeset-transition-internal-panels)
[416.871176] Starting subtest: plane-all-modeset-transition-internal-panels
[416.873054] Starting dynamic subtest: pipe-A-eDP-1
[418.226703] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.355s)
[418.503429] Starting dynamic subtest: pipe-B-eDP-1
[419.543049] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.050s)
[419.811573] Subtest plane-all-modeset-transition-internal-panels: SUCCESS (2.942s)
[420.661092] [068/133] (600s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-move)
[420.762390] Starting subtest: psr-2p-scndscrn-spr-indfb-move
[420.766457] Subtest psr-2p-scndscrn-spr-indfb-move: SKIP (0.000s)
[420.865161] [069/133] (600s left) kms_flip_scaled_crc (flip-32bpp-yftileccs-to-64bpp-yftile-downscaling)
[420.966420] Starting subtest: flip-32bpp-yftileccs-to-64bpp-yftile-downscaling
[420.970626] Subtest flip-32bpp-yftileccs-to-64bpp-yftile-downscaling: SKIP (0.000s)
[421.039449] [070/133] (600s left) gem_exec_schedule (semaphore-noskip)
[421.110509] Starting subtest: semaphore-noskip
[421.515265] Subtest semaphore-noskip: SUCCESS (0.411s)
[421.860160] [071/133] (599s left) kms_psr (pr-no-drrs)
[421.948934] Starting subtest: pr-no-drrs
[421.953352] Subtest pr-no-drrs: SKIP (0.000s)
[422.022351] [072/133] (599s left) kms_cursor_legacy (cursora-vs-flipa-toggle)
[422.146163] Starting subtest: cursorA-vs-flipA-toggle
[433.280970] Subtest cursorA-vs-flipA-toggle: SUCCESS (11.134s)
[434.091683] [073/133] (587s left) kms_flip (dpms-vs-vblank-race)
[434.201455] Starting subtest: dpms-vs-vblank-race
[434.203840] Starting dynamic subtest: A-eDP1
[439.196887] Dynamic subtest A-eDP1: SUCCESS (4.995s)
[439.207881] Starting dynamic subtest: B-eDP1
[442.710395] Dynamic subtest B-eDP1: SUCCESS (3.511s)
[442.720946] Starting dynamic subtest: C-eDP1
[447.334862] Dynamic subtest C-eDP1: SUCCESS (4.622s)
[447.344323] Starting dynamic subtest: D-eDP1
[451.956697] Dynamic subtest D-eDP1: SUCCESS (4.623s)
[451.961608] Subtest dpms-vs-vblank-race: SUCCESS (17.764s)
[452.838251] [074/133] (568s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-move)
[452.941736] Starting subtest: psr-2p-scndscrn-cur-indfb-move
[452.945773] Subtest psr-2p-scndscrn-cur-indfb-move: SKIP (0.000s)
[453.046309] [075/133] (568s left) gem_exec_balancer (bonded-false-hang)
[453.310287] Starting subtest: bonded-false-hang
[453.316511] Subtest bonded-false-hang: SKIP (0.000s)
[453.416670] [076/133] (568s left) kms_plane_scaling (plane-upscale-factor-0-25-with-rotation)
[453.513257] Starting subtest: plane-upscale-factor-0-25-with-rotation
[453.515579] Starting dynamic subtest: pipe-A
[453.738269] Dynamic subtest pipe-A: SUCCESS (0.227s)
[453.747831] Starting dynamic subtest: pipe-B
[455.016641] Dynamic subtest pipe-B: SUCCESS (1.277s)
[455.025910] Starting dynamic subtest: pipe-C
[456.337180] Dynamic subtest pipe-C: SUCCESS (1.319s)
[456.347774] Starting dynamic subtest: pipe-D
[457.678104] Dynamic subtest pipe-D: SUCCESS (1.340s)
[457.680479] Subtest plane-upscale-factor-0-25-with-rotation: SUCCESS (4.169s)
[458.865617] [077/133] (562s left) gem_ctx_param (get-priority-new-ctx)
[458.924399] Starting subtest: get-priority-new-ctx
[458.926762] Subtest get-priority-new-ctx: SUCCESS (0.001s)
[459.033719] [078/133] (562s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-gtt)
[459.133742] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-gtt
[459.137692] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[459.227917] [079/133] (562s left) kms_joiner (invalid-modeset-force-big-joiner)
[459.325598] Starting subtest: invalid-modeset-force-big-joiner
[459.329841] Subtest invalid-modeset-force-big-joiner: SKIP (0.000s)
[459.406654] [080/133] (562s left) kms_big_fb (yf-tiled-8bpp-rotate-270)
[459.510164] Starting subtest: yf-tiled-8bpp-rotate-270
[459.514474] Subtest yf-tiled-8bpp-rotate-270: SKIP (0.000s)
[459.609277] [081/133] (562s left) gem_ringfill (legacy-basic)
[465.379994] Starting subtest: legacy-basic
[465.382755] Starting dynamic subtest: default
[465.436227] Dynamic subtest default: SUCCESS (0.056s)
[465.447726] Starting dynamic subtest: render
[465.478099] Dynamic subtest render: SUCCESS (0.040s)
[465.488173] Starting dynamic subtest: bsd
[465.521193] Dynamic subtest bsd: SUCCESS (0.041s)
[465.531665] Starting dynamic subtest: bsd1
[465.562267] Dynamic subtest bsd1: SUCCESS (0.039s)
[465.575009] Starting dynamic subtest: bsd2
[465.605455] Dynamic subtest bsd2: SUCCESS (0.040s)
[465.616484] Starting dynamic subtest: blt
[465.649178] Dynamic subtest blt: SUCCESS (0.041s)
[465.659494] Starting dynamic subtest: vebox
[465.691269] Dynamic subtest vebox: SUCCESS (0.040s)
[465.693706] Subtest legacy-basic: SUCCESS (0.314s)
[465.769356] [082/133] (556s left) vgem_basic (debugfs)
[465.811759] Starting subtest: debugfs
[465.813612] Subtest debugfs: SUCCESS (0.000s)
[465.867821] [083/133] (556s left) perf (invalid-remove-userspace-config)
[466.021311] Starting subtest: invalid-remove-userspace-config
[466.030221] Subtest invalid-remove-userspace-config: SUCCESS (0.011s)
[466.071750] [084/133] (556s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-plflip-blt)
[466.181631] Starting subtest: psr-1p-primscrn-shrfb-plflip-blt
[473.541613] Subtest psr-1p-primscrn-shrfb-plflip-blt: SUCCESS (7.362s)
[473.665387] [085/133] (548s left) gem_ctx_bad_destroy (invalid-default-ctx)
[473.727332] Starting subtest: invalid-default-ctx
[473.729774] Subtest invalid-default-ctx: SUCCESS (0.000s)
[473.813534] [086/133] (548s left) kms_cursor_legacy (basic-flip-after-cursor-legacy)
[473.928560] Starting subtest: basic-flip-after-cursor-legacy
[474.846971] Subtest basic-flip-after-cursor-legacy: SUCCESS (0.919s)
[475.697234] [087/133] (546s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-gtt)
[475.803832] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-gtt
[475.808270] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[475.901910] [088/133] (546s left) gem_render_copy (y-tiled-ccs-to-linear)
[475.974490] Starting subtest: y-tiled-ccs-to-linear
[475.978968] Subtest y-tiled-ccs-to-linear: SKIP (0.000s)
[476.160969] [089/133] (546s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-mmap-gtt)
[476.264100] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-mmap-gtt
[476.268489] Subtest fbc-1p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[476.370950] [090/133] (545s left) kms_legacy_colorkey (invalid-plane)
[476.469452] Starting subtest: invalid-plane
[476.471659] Starting dynamic subtest: zero-id
[476.473575] Dynamic subtest zero-id: SUCCESS (0.000s)
[476.483904] Starting dynamic subtest: outrange-id
[476.486147] Dynamic subtest outrange-id: SUCCESS (0.000s)
[476.488336] Subtest invalid-plane: SUCCESS (0.001s)
[476.543982] [091/133] (545s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-render)
[476.644971] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-render
[476.649335] Subtest fbc-2p-primscrn-pri-indfb-draw-render: SKIP (0.000s)
[476.745893] [092/133] (545s left) gem_mmap_offset (pf-nonblock)
[476.809668] Starting subtest: pf-nonblock
[476.814721] Subtest pf-nonblock: SUCCESS (0.006s)
[476.930360] [093/133] (545s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-mmap-wc)
[477.019518] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-mmap-wc
[480.607775] Subtest fbc-1p-primscrn-cur-indfb-draw-mmap-wc: SUCCESS (3.590s)
[481.811161] [094/133] (540s left) i915_drm_fdinfo (virtual-busy-hang)
[481.854521] Starting subtest: virtual-busy-hang
[481.858442] Subtest virtual-busy-hang: SKIP (0.000s)
[481.934038] [095/133] (540s left) gem_mmap_wc (write-cpu-read-wc)
[481.995345] Subtest write-cpu-read-wc: SKIP (0.000s)
[482.059724] [096/133] (540s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-onoff)
[482.154763] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-onoff
[482.158791] Subtest fbcpsr-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s)
[482.238510] [097/133] (540s left) kms_chamelium_color (ctm-0-25)
[482.338861] Subtest ctm-0-25: SKIP (0.000s)
[482.384432] [098/133] (540s left) syncobj_timeline (wait-zero-handles)
[482.449344] Starting subtest: wait-zero-handles
[482.451868] Subtest wait-zero-handles: SUCCESS (0.000s)
[482.558706] [099/133] (540s left) kms_psr (fbc-psr-cursor-render)
[482.639089] Starting subtest: fbc-psr-cursor-render
[482.641511] Starting dynamic subtest: eDP-1
[482.646088] Dynamic subtest eDP-1: SKIP (0.000s)
[482.650773] Subtest fbc-psr-cursor-render: SKIP (0.001s)
[482.712495] [100/133] (540s left) gem_exec_fence (syncobj-channel)
[483.143774] Starting subtest: syncobj-channel
[484.163666] Subtest syncobj-channel: SUCCESS (1.015s)
[484.496767] [101/133] (538s left) gen9_exec_parse (bb-start-param)
[484.551828] Subtest bb-start-param: SKIP (0.000s)
[484.621040] [102/133] (538s left) kms_color (invalid-gamma-lut-sizes)
[484.719314] Starting subtest: invalid-gamma-lut-sizes
[484.721588] Starting dynamic subtest: pipe-A
[485.020753] Dynamic subtest pipe-A: SUCCESS (0.300s)
[485.031647] Starting dynamic subtest: pipe-B
[485.033989] Dynamic subtest pipe-B: SUCCESS (0.000s)
[485.043742] Starting dynamic subtest: pipe-C
[485.046006] Dynamic subtest pipe-C: SUCCESS (0.000s)
[485.055682] Starting dynamic subtest: pipe-D
[485.057698] Dynamic subtest pipe-D: SUCCESS (0.000s)
[485.059727] Subtest invalid-gamma-lut-sizes: SUCCESS (0.304s)
[485.836159] [103/133] (537s left) syncobj_timeline (reset-multiple-signaled)
[485.890866] Starting subtest: reset-multiple-signaled
[485.893102] Subtest reset-multiple-signaled: SUCCESS (0.000s)
[486.002359] [104/133] (536s left) kms_cursor_legacy (forked-move)
[486.115283] Starting subtest: forked-move
[486.117433] Starting dynamic subtest: pipe-A
[491.598098] Dynamic subtest pipe-A: SUCCESS (5.480s)
[491.611014] Starting dynamic subtest: pipe-B
[497.070856] Dynamic subtest pipe-B: SUCCESS (5.470s)
[497.081948] Starting dynamic subtest: pipe-C
[502.545967] Dynamic subtest pipe-C: SUCCESS (5.472s)
[502.557475] Starting dynamic subtest: pipe-D
[508.014376] Dynamic subtest pipe-D: SUCCESS (5.466s)
[508.025911] Starting dynamic subtest: all-pipes
[513.502725] Dynamic subtest all-pipes: SUCCESS (5.486s)
[513.505215] Subtest forked-move: SUCCESS (27.385s)
[513.650380] [105/133] (509s left) kms_frontbuffer_tracking (fbc-2p-shrfb-fliptrack-mmap-gtt)
[513.758786] Starting subtest: fbc-2p-shrfb-fliptrack-mmap-gtt
[513.763021] Subtest fbc-2p-shrfb-fliptrack-mmap-gtt: SKIP (0.000s)
[513.875061] [106/133] (509s left) gem_wait (write-busy)
[513.949974] Starting subtest: write-busy
[513.952359] Starting dynamic subtest: all-engines
[514.535813] Dynamic subtest all-engines: SUCCESS (0.586s)
[514.552332] Starting dynamic subtest: rcs0
[515.083020] Dynamic subtest rcs0: SUCCESS (0.546s)
[515.099226] Starting dynamic subtest: bcs0
[515.631975] Dynamic subtest bcs0: SUCCESS (0.548s)
[515.647761] Starting dynamic subtest: vcs0
[517.407749] Dynamic subtest vcs0: SUCCESS (1.773s)
[517.423909] Starting dynamic subtest: vcs1
[519.391803] Dynamic subtest vcs1: SUCCESS (1.982s)
[519.408292] Starting dynamic subtest: vecs0
[521.377118] Dynamic subtest vecs0: SUCCESS (1.982s)
[521.394166] Starting dynamic subtest: ccs0
[521.927466] Dynamic subtest ccs0: SUCCESS (0.550s)
[521.929924] Subtest write-busy: SUCCESS (7.978s)
[522.130455] [107/133] (500s left) i915_pm_rps (basic-api)
[522.198916] Starting subtest: basic-api
[522.203854] Subtest basic-api: SKIP (0.002s)
[522.303680] [108/133] (500s left) gem_render_copy (y-tiled)
[522.368941] Starting subtest: y-tiled
[522.373529] Subtest y-tiled: SKIP (0.000s)
[522.550180] [109/133] (500s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc)
[522.667422] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc
[522.671349] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[522.770754] [110/133] (500s left) kms_flip (2x-flip-vs-panning-interruptible)
[522.871495] Starting subtest: 2x-flip-vs-panning-interruptible
[522.882721] Subtest 2x-flip-vs-panning-interruptible: SKIP (0.010s)
[522.974462] [111/133] (500s left) gem_lmem_swapping (parallel-random-engines)
[523.010082] Subtest parallel-random-engines: SKIP (0.000s)
[523.065577] [112/133] (500s left) kms_psr2_sf (fbc-psr2-overlay-plane-move-continuous-sf)
[523.163284] Starting subtest: fbc-psr2-overlay-plane-move-continuous-sf
[523.165512] Starting dynamic subtest: pipe-A-eDP-1
[523.248290] Dynamic subtest pipe-A-eDP-1: SKIP (0.089s)
[523.259521] Starting dynamic subtest: pipe-B-eDP-1
[524.407724] Dynamic subtest pipe-B-eDP-1: SKIP (1.158s)
[524.412243] Subtest fbc-psr2-overlay-plane-move-continuous-sf: SKIP (1.249s)
[525.594726] [113/133] (497s left) gem_ctx_persistence (process)
[525.670303] Starting subtest: process
[525.857480] Subtest process: SUCCESS (0.187s)
[525.937392] [114/133] (497s left) api_intel_allocator (two-level-inception-interruptible)
[525.994256] Starting subtest: two-level-inception-interruptible
[531.398238] Subtest two-level-inception-interruptible: SUCCESS (5.406s)
[531.501740] [115/133] (491s left) gem_create (create-clear)
[531.566627] Starting subtest: create-clear
[531.568745] Starting dynamic subtest: smem0
[564.400811] Dynamic subtest smem0: SUCCESS (32.835s)
[564.403004] Subtest create-clear: SUCCESS (32.836s)
[564.589081] [116/133] (458s left) kms_psr (fbc-pr-primary-render)
[564.687295] Starting subtest: fbc-pr-primary-render
[564.691861] Subtest fbc-pr-primary-render: SKIP (0.000s)
[564.759121] [117/133] (458s left) kms_ccs (bad-rotation-90-4-tiled-mtl-mc-ccs)
[564.854341] Starting subtest: bad-rotation-90-4-tiled-mtl-mc-ccs
[564.856196] Starting dynamic subtest: pipe-A-eDP-1
[565.272091] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.418s)
[565.285162] Starting dynamic subtest: pipe-B-eDP-1
[565.306958] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.003s)
[565.317377] Starting dynamic subtest: pipe-C-eDP-1
[565.337229] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.004s)
[565.346695] Starting dynamic subtest: pipe-D-eDP-1
[565.367140] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.004s)
[565.369473] Subtest bad-rotation-90-4-tiled-mtl-mc-ccs: SUCCESS (0.433s)
[567.562806] [118/133] (455s left) syncobj_timeline (invalid-signal-illegal-point)
[567.618042] Starting subtest: invalid-signal-illegal-point
[567.620341] Subtest invalid-signal-illegal-point: SUCCESS (0.000s)
[567.720026] [119/133] (455s left) gem_ctx_exec (basic)
[567.772363] Starting subtest: basic
[567.777421] Subtest basic: SUCCESS (0.006s)
[567.914219] [120/133] (455s left) kms_big_fb (x-tiled-16bpp-rotate-0)
[568.011019] Starting subtest: x-tiled-16bpp-rotate-0
[569.335074] Subtest x-tiled-16bpp-rotate-0: SUCCESS (1.325s)
[569.470198] [121/133] (454s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180)
[569.563274] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180
[570.563518] Subtest x-tiled-max-hw-stride-32bpp-rotate-180: SUCCESS (1.001s)
[570.674820] [122/133] (453s left) perf (short-reads)
[570.766899] Starting subtest: short-reads
[570.779555] Subtest short-reads: SUCCESS (0.015s)
[570.834361] [123/133] (452s left) dmabuf_sync_file (import-multiple-read-write)
[570.871647] Starting subtest: import-multiple-read-write
[570.875581] Subtest import-multiple-read-write: SUCCESS (0.003s)
[570.927820] [124/133] (452s left) kms_plane (pixel-format-y-tiled-ccs-modifier)
[571.020305] Starting subtest: pixel-format-y-tiled-ccs-modifier
[571.023566] Subtest pixel-format-y-tiled-ccs-modifier: SKIP (0.000s)
[571.089996] [125/133] (452s left) gem_ctx_freq (sysfs)
[571.146643] Starting subtest: sysfs
[571.148380] Starting dynamic subtest: gt0
[576.647771] Dynamic subtest gt0: SUCCESS (5.500s)
[576.657361] Starting dynamic subtest: gt1
[618.399161] Dynamic subtest gt1: SUCCESS (41.755s)
[618.402075] Subtest sysfs: SUCCESS (47.258s)
[618.516552] [126/133] (405s left) kms_ccs (crc-primary-basic-y-tiled-gen12-rc-ccs-cc)
[618.616740] Starting subtest: crc-primary-basic-y-tiled-gen12-rc-ccs-cc
[618.619075] Starting dynamic subtest: pipe-A-eDP-1
[618.641389] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[618.653461] Starting dynamic subtest: pipe-B-eDP-1
[618.674881] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[618.687088] Starting dynamic subtest: pipe-C-eDP-1
[618.708397] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[618.717948] Starting dynamic subtest: pipe-D-eDP-1
[618.741113] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[618.745508] Subtest crc-primary-basic-y-tiled-gen12-rc-ccs-cc: SKIP (0.006s)
[620.916771] [127/133] (402s left) kms_addfb_basic (addfb25-yf-tiled-legacy)
[621.012264] Starting subtest: addfb25-yf-tiled-legacy
[621.014105] Subtest addfb25-yf-tiled-legacy: SUCCESS (0.000s)
[621.111163] [128/133] (402s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-pgflip-blt)
[621.213758] Starting subtest: fbc-2p-primscrn-shrfb-pgflip-blt
[621.217926] Subtest fbc-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[621.332499] [129/133] (402s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-mmap-gtt)
[621.435173] Starting subtest: psr-2p-primscrn-pri-indfb-draw-mmap-gtt
[621.439321] Subtest psr-2p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[621.533881] [130/133] (402s left) gem_exec_whisper (basic-queues)
[621.602966] Starting subtest: basic-queues
[627.333241] Subtest basic-queues: SUCCESS (5.728s)
[627.535474] [131/133] (396s left) kms_cursor_legacy (2x-nonblocking-modeset-vs-cursor-atomic)
[627.665808] Starting subtest: 2x-nonblocking-modeset-vs-cursor-atomic
[627.670439] Subtest 2x-nonblocking-modeset-vs-cursor-atomic: SKIP (0.001s)
[627.810250] [132/133] (396s left) kms_multipipe_modeset (basic-max-pipe-crc-check)
[627.909782] Starting subtest: basic-max-pipe-crc-check
[627.913927] Subtest basic-max-pipe-crc-check: SKIP (0.000s)
[627.956396] [133/133] (396s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180-hflip)
[628.056723] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180-hflip
[628.061229] Subtest y-tiled-max-hw-stride-32bpp-rotate-180-hflip: SKIP (0.000s)
[628.157041] Closing watchdogs
results: parsing output: 0/ for test: kms_async_flips
results: parsing output: 1/ for test: gem_exec_flush
results: parsing output: 2/ for test: perf
results: parsing output: 3/ for test: gem_exec_fence
results: parsing output: 4/ for test: kms_content_protection
results: parsing output: 5/ for test: kms_vblank
results: parsing output: 6/ for test: kms_flip
results: parsing output: 7/ for test: kms_chamelium_hpd
results: parsing output: 8/ for test: syncobj_timeline
results: parsing output: 9/ for test: kms_hdr
results: parsing output: 10/ for test: gem_userptr_blits
results: parsing output: 11/ for test: perf_pmu
results: parsing output: 12/ for test: kms_rotation_crc
results: parsing output: 13/ for test: kms_plane
results: parsing output: 14/ for test: kms_dsc
results: parsing output: 15/ for test: kms_cursor_legacy
results: parsing output: 16/ for test: kms_frontbuffer_tracking
results: parsing output: 17/ for test: kms_chamelium_frames
results: parsing output: 18/ for test: gem_exec_create
results: parsing output: 19/ for test: gem_mmap_offset
results: parsing output: 20/ for test: kms_prop_blob
results: parsing output: 21/ for test: kms_pm_dc
results: parsing output: 22/ for test: gem_ctx_shared
results: parsing output: 23/ for test: fbdev
results: parsing output: 24/ for test: kms_frontbuffer_tracking
results: parsing output: 25/ for test: kms_cursor_crc
results: parsing output: 26/ for test: gem_render_copy
results: parsing output: 27/ for test: kms_ccs
results: parsing output: 28/ for test: kms_pm_rpm
results: parsing output: 29/ for test: kms_big_fb
results: parsing output: 30/ for test: syncobj_timeline
results: parsing output: 31/ for test: perf
results: parsing output: 32/ for test: syncobj_basic
results: parsing output: 33/ for test: kms_cursor_crc
results: parsing output: 34/ for test: kms_addfb_basic
results: parsing output: 35/ for test: kms_flip
results: parsing output: 36/ for test: gem_fence_thrash
results: parsing output: 37/ for test: gem_set_tiling_vs_blt
results: parsing output: 38/ for test: kms_atomic_transition
results: parsing output: 39/ for test: kms_cursor_edge_walk
results: parsing output: 40/ for test: kms_frontbuffer_tracking
results: parsing output: 41/ for test: perf_pmu
results: parsing output: 42/ for test: kms_cursor_legacy
results: parsing output: 43/ for test: syncobj_timeline
results: parsing output: 44/ for test: kms_psr
results: parsing output: 45/ for test: kms_psr
results: parsing output: 46/ for test: prime_busy
results: parsing output: 47/ for test: i915_suspend
results: parsing output: 48/ for test: kms_flip_scaled_crc
results: parsing output: 49/ for test: kms_selftest
results: parsing output: 50/ for test: i915_module_load
results: parsing output: 51/ for test: gem_lmem_swapping
results: parsing output: 52/ for test: kms_frontbuffer_tracking
results: parsing output: 53/ for test: kms_frontbuffer_tracking
results: parsing output: 54/ for test: gem_mmap_gtt
results: parsing output: 55/ for test: gem_softpin
results: parsing output: 56/ for test: gem_exec_schedule
results: parsing output: 57/ for test: kms_ccs
results: parsing output: 58/ for test: api_intel_bb
results: parsing output: 59/ for test: kms_cursor_legacy
results: parsing output: 60/ for test: kms_frontbuffer_tracking
results: parsing output: 61/ for test: kms_big_fb
results: parsing output: 62/ for test: kms_big_fb
results: parsing output: 63/ for test: kms_plane_cursor
results: parsing output: 64/ for test: gem_userptr_blits
results: parsing output: 65/ for test: kms_cursor_legacy
results: parsing output: 66/ for test: kms_atomic_transition
results: parsing output: 67/ for test: kms_frontbuffer_tracking
results: parsing output: 68/ for test: kms_flip_scaled_crc
results: parsing output: 69/ for test: gem_exec_schedule
results: parsing output: 70/ for test: kms_psr
results: parsing output: 71/ for test: kms_cursor_legacy
results: parsing output: 72/ for test: kms_flip
results: parsing output: 73/ for test: kms_frontbuffer_tracking
results: parsing output: 74/ for test: gem_exec_balancer
results: parsing output: 75/ for test: kms_plane_scaling
results: parsing output: 76/ for test: gem_ctx_param
results: parsing output: 77/ for test: kms_frontbuffer_tracking
results: parsing output: 78/ for test: kms_joiner
results: parsing output: 79/ for test: kms_big_fb
results: parsing output: 80/ for test: gem_ringfill
results: parsing output: 81/ for test: vgem_basic
results: parsing output: 82/ for test: perf
results: parsing output: 83/ for test: kms_frontbuffer_tracking
results: parsing output: 84/ for test: gem_ctx_bad_destroy
results: parsing output: 85/ for test: kms_cursor_legacy
results: parsing output: 86/ for test: kms_frontbuffer_tracking
results: parsing output: 87/ for test: gem_render_copy
results: parsing output: 88/ for test: kms_frontbuffer_tracking
results: parsing output: 89/ for test: kms_legacy_colorkey
results: parsing output: 90/ for test: kms_frontbuffer_tracking
results: parsing output: 91/ for test: gem_mmap_offset
results: parsing output: 92/ for test: kms_frontbuffer_tracking
results: parsing output: 93/ for test: i915_drm_fdinfo
results: parsing output: 94/ for test: gem_mmap_wc
results: parsing output: 95/ for test: kms_frontbuffer_tracking
results: parsing output: 96/ for test: kms_chamelium_color
results: parsing output: 97/ for test: syncobj_timeline
results: parsing output: 98/ for test: kms_psr
results: parsing output: 99/ for test: gem_exec_fence
results: parsing output: 100/ for test: gen9_exec_parse
results: parsing output: 101/ for test: kms_color
results: parsing output: 102/ for test: syncobj_timeline
results: parsing output: 103/ for test: kms_cursor_legacy
results: parsing output: 104/ for test: kms_frontbuffer_tracking
results: parsing output: 105/ for test: gem_wait
results: parsing output: 106/ for test: i915_pm_rps
results: parsing output: 107/ for test: gem_render_copy
results: parsing output: 108/ for test: kms_frontbuffer_tracking
results: parsing output: 109/ for test: kms_flip
results: parsing output: 110/ for test: gem_lmem_swapping
results: parsing output: 111/ for test: kms_psr2_sf
results: parsing output: 112/ for test: gem_ctx_persistence
results: parsing output: 113/ for test: api_intel_allocator
results: parsing output: 114/ for test: gem_create
results: parsing output: 115/ for test: kms_psr
results: parsing output: 116/ for test: kms_ccs
results: parsing output: 117/ for test: syncobj_timeline
results: parsing output: 118/ for test: gem_ctx_exec
results: parsing output: 119/ for test: kms_big_fb
results: parsing output: 120/ for test: kms_big_fb
results: parsing output: 121/ for test: perf
results: parsing output: 122/ for test: dmabuf_sync_file
results: parsing output: 123/ for test: kms_plane
results: parsing output: 124/ for test: gem_ctx_freq
results: parsing output: 125/ for test: kms_ccs
results: parsing output: 126/ for test: kms_addfb_basic
results: parsing output: 127/ for test: kms_frontbuffer_tracking
results: parsing output: 128/ for test: kms_frontbuffer_tracking
results: parsing output: 129/ for test: gem_exec_whisper
results: parsing output: 130/ for test: kms_cursor_legacy
results: parsing output: 131/ for test: kms_multipipe_modeset
results: parsing output: 132/ for test: kms_big_fb
Done.