[58.445408] Initializing watchdogs
[58.445455]   /dev/watchdog0
[58.459113] [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.463246] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[58.465405] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[58.469012] [001/133] (960s left) perf_pmu (frequency)
[58.540374] Starting subtest: frequency
[58.542714] Starting dynamic subtest: gt0
[60.690389] Dynamic subtest gt0: SUCCESS (2.155s)
[60.698963] Starting dynamic subtest: idle-gt0
[61.217499] Dynamic subtest idle-gt0: SUCCESS (0.528s)
[61.227634] Starting dynamic subtest: gt1
[65.863907] Dynamic subtest gt1: SUCCESS (4.658s)
[65.871083] Starting dynamic subtest: idle-gt1
[66.405741] Dynamic subtest idle-gt1: SUCCESS (0.544s)
[66.408266] Subtest frequency: SUCCESS (7.896s)
[66.536757] [002/133] (952s left) syncobj_wait (wait-any-complex)
[66.593759] Starting subtest: wait-any-complex
[66.653809] Subtest wait-any-complex: SUCCESS (0.061s)
[66.754124] [003/133] (952s left) gem_exec_capture (capture-recoverable)
[66.841861] Starting subtest: capture-recoverable
[66.849407] Subtest capture-recoverable: SUCCESS (0.005s)
[67.088899] [004/133] (952s left) gem_userptr_blits (stress-purge)
[67.356179] Starting subtest: stress-purge
[72.744508] Subtest stress-purge: SUCCESS (5.395s)
[72.896500] [005/133] (946s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-move)
[73.045666] Starting subtest: fbc-2p-primscrn-cur-indfb-move
[73.049163] Subtest fbc-2p-primscrn-cur-indfb-move: SKIP (0.000s)
[73.169554] [006/133] (946s left) kms_psr (pr-primary-mmap-cpu)
[73.258082] Starting subtest: pr-primary-mmap-cpu
[73.261845] Subtest pr-primary-mmap-cpu: SKIP (0.000s)
[73.333811] [007/133] (945s left) gem_exec_fence (syncobj-unused-fence)
[73.762812] Starting subtest: syncobj-unused-fence
[73.767824] Subtest syncobj-unused-fence: SUCCESS (0.005s)
[74.971922] [FACT gem_exec_fence (syncobj-unused-fence)] new: kernel.kmod_is_loaded.vgem: true
[74.975169] [008/133] (944s left) prime_self_import (basic-llseek-bad)
[75.010743] Starting subtest: basic-llseek-bad
[75.035790] Subtest basic-llseek-bad: SUCCESS (0.028s)
[75.160673] [009/133] (944s left) kms_pm_rpm (modeset-lpsp-stress-no-wait)
[77.020581] Starting subtest: modeset-lpsp-stress-no-wait
[86.733663] Subtest modeset-lpsp-stress-no-wait: SUCCESS (9.709s)
[86.821096] [010/133] (932s left) syncobj_timeline (etime-single-wait-all-for-submit-available-unsubmitted)
[86.902339] Starting subtest: etime-single-wait-all-for-submit-available-unsubmitted
[87.009061] Subtest etime-single-wait-all-for-submit-available-unsubmitted: SUCCESS (0.104s)
[87.105572] [011/133] (932s left) kms_async_flips (invalid-async-flip-atomic)
[87.198384] Starting subtest: invalid-async-flip-atomic
[87.574975] Starting dynamic subtest: pipe-A-eDP-1
[88.408144] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.834s)
[88.769925] Starting dynamic subtest: pipe-B-eDP-1
[89.545065] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.782s)
[89.904285] Starting dynamic subtest: pipe-C-eDP-1
[90.657762] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.763s)
[91.008956] Starting dynamic subtest: pipe-D-eDP-1
[91.787163] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.783s)
[91.789329] Subtest invalid-async-flip-atomic: SUCCESS (4.587s)
[92.965905] [012/133] (926s left) kms_cursor_crc (cursor-rapid-movement-64x64)
[93.142442] Starting subtest: cursor-rapid-movement-64x64
[93.146894] Starting dynamic subtest: pipe-A-eDP-1
[93.674624] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.528s)
[93.700259] Starting dynamic subtest: pipe-D-eDP-1
[94.845215] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.148s)
[94.847424] Subtest cursor-rapid-movement-64x64: SUCCESS (1.700s)
[95.713783] [013/133] (923s left) kms_big_fb (x-tiled-64bpp-rotate-0)
[95.815507] Starting subtest: x-tiled-64bpp-rotate-0
[97.373385] Subtest x-tiled-64bpp-rotate-0: SUCCESS (1.557s)
[97.561763] [014/133] (921s left) gem_workarounds (suspend-resume-context)
[97.641804] Starting subtest: suspend-resume-context
[113.904670] Subtest suspend-resume-context: SUCCESS (1.277s)
[114.044678] [015/133] (905s left) gem_exec_schedule (u-semaphore-user)
[114.137655] Starting subtest: u-semaphore-user
[114.188566] Subtest u-semaphore-user: SUCCESS (0.057s)
[115.918292] [016/133] (903s left) syncobj_timeline (wait-delayed-signal)
[115.977416] Starting subtest: wait-delayed-signal
[116.079340] Subtest wait-delayed-signal: SUCCESS (0.105s)
[116.168510] [017/133] (903s left) kms_pipe_stress (stress-xrgb8888-xtiled)
[116.279724] Starting subtest: stress-xrgb8888-xtiled
[122.033333] Subtest stress-xrgb8888-xtiled: SUCCESS (5.864s)
[122.087137] [018/133] (897s left) gem_userptr_blits (unsync-unmap-cycles)
[122.161640] Subtest unsync-unmap-cycles: SKIP (0.000s)
[122.306401] [019/133] (897s left) kms_dsc (dsc-fractional-bpp-with-bpc)
[122.409214] Starting subtest: dsc-fractional-bpp-with-bpc
[122.434539] Subtest dsc-fractional-bpp-with-bpc: SKIP (0.001s)
[122.505313] [020/133] (897s left) kms_cursor_crc (cursor-onscreen-32x10)
[122.675662] Starting subtest: cursor-onscreen-32x10
[122.717596] Subtest cursor-onscreen-32x10: SKIP (0.039s)
[122.983610] [021/133] (896s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip)
[123.092420] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip
[123.853894] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip: SUCCESS (0.770s)
[124.076966] [022/133] (895s left) perf (enable-disable)
[124.219576] Starting subtest: enable-disable
[124.221514] Starting dynamic subtest: 0-rcs0
[126.512849] Dynamic subtest 0-rcs0: SUCCESS (2.276s)
[126.524510] Starting dynamic subtest: 1-vecs0
[130.939441] Dynamic subtest 1-vecs0: SUCCESS (4.487s)
[130.941814] Subtest enable-disable: SUCCESS (6.764s)
[130.986363] [023/133] (888s left) kms_plane (pixel-format-4-tiled-lnl-ccs-modifier-source-clamping)
[131.092814] Starting subtest: pixel-format-4-tiled-lnl-ccs-modifier-source-clamping
[131.097078] Subtest pixel-format-4-tiled-lnl-ccs-modifier-source-clamping: SKIP (0.000s)
[131.177910] [024/133] (888s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-mmap-wc)
[131.282275] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-mmap-wc
[137.793059] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-mmap-wc: SUCCESS (6.532s)
[137.979718] [025/133] (881s left) kms_addfb_basic (legacy-format)
[138.046922] Starting subtest: legacy-format
[138.065457] Subtest legacy-format: SUCCESS (0.018s)
[138.252383] [026/133] (881s left) prime_vgem (fence-write-hang)
[138.339940] Subtest fence-write-hang: SKIP (0.000s)
[138.479581] [027/133] (881s left) kms_psr2_sf (fbc-pr-overlay-plane-update-sf-dmg-area)
[138.580244] Starting subtest: fbc-pr-overlay-plane-update-sf-dmg-area
[138.584002] Subtest fbc-pr-overlay-plane-update-sf-dmg-area: SKIP (0.000s)
[138.667834] [028/133] (881s left) perf_pmu (module-unload)
[138.773642] Starting subtest: module-unload
[145.705055] Subtest module-unload: FAIL (6.838s)
[145.736060] [FACT perf_pmu (module-unload)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[145.736755] [FACT perf_pmu (module-unload)] deleted: kernel.kmod_is_loaded.i915: true
[145.739720] [029/133] (874s left) kms_cursor_legacy (cursor-vs-flip-varying-size)
[147.307194] Starting subtest: cursor-vs-flip-varying-size
[178.030155] Subtest cursor-vs-flip-varying-size: SUCCESS (30.725s)
[178.864452] [FACT kms_cursor_legacy (cursor-vs-flip-varying-size)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[178.865702] [FACT kms_cursor_legacy (cursor-vs-flip-varying-size)] new: kernel.kmod_is_loaded.i915: true
[178.869618] [030/133] (841s left) kms_psr2_sf (psr2-overlay-plane-move-continuous-exceed-fully-sf)
[178.969448] Starting subtest: psr2-overlay-plane-move-continuous-exceed-fully-sf
[178.971785] Starting dynamic subtest: pipe-A-eDP-1
[195.423822] Dynamic subtest pipe-A-eDP-1: SUCCESS (16.466s)
[195.432740] Starting dynamic subtest: pipe-B-eDP-1
[212.598281] Dynamic subtest pipe-B-eDP-1: SUCCESS (17.173s)
[212.600645] Subtest psr2-overlay-plane-move-continuous-exceed-fully-sf: SUCCESS (33.643s)
[213.415630] [031/133] (806s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-submitted-signa
[213.487575] Starting subtest: multi-wait-for-submit-available-unsubmitted-submitted-signaled
[213.489972] Subtest multi-wait-for-submit-available-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[213.614822] [032/133] (806s left) kms_psr (fbc-pr-suspend)
[213.716491] Starting subtest: fbc-pr-suspend
[213.721075] Subtest fbc-pr-suspend: SKIP (0.000s)
[213.800130] [033/133] (806s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-cpu)
[213.904400] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-mmap-cpu
[213.908522] Subtest fbc-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[214.024359] [034/133] (806s left) gem_ctx_shared (create-shared-gtt)
[214.086951] Starting subtest: create-shared-gtt
[216.241095] Subtest create-shared-gtt: SUCCESS (2.150s)
[216.630640] [035/133] (803s left) kms_flip (flip-vs-suspend)
[216.730867] Starting subtest: flip-vs-suspend
[216.733183] Starting dynamic subtest: A-eDP1
[265.912368] Dynamic subtest A-eDP1: SUCCESS (4.549s)
[265.928047] Starting dynamic subtest: B-eDP1
[314.923469] Dynamic subtest B-eDP1: SUCCESS (4.465s)
[314.933382] Starting dynamic subtest: C-eDP1
[363.929262] Dynamic subtest C-eDP1: SUCCESS (4.530s)
[363.943831] Starting dynamic subtest: D-eDP1
[412.913819] Dynamic subtest D-eDP1: SUCCESS (4.540s)
[412.915959] Subtest flip-vs-suspend: SUCCESS (18.094s)
[414.074828] [036/133] (606s left) kms_cursor_legacy (cursora-vs-flipa-atomic)
[414.190742] Starting subtest: cursorA-vs-flipA-atomic
[425.148694] Subtest cursorA-vs-flipA-atomic: SUCCESS (11.125s)
[426.031710] [037/133] (594s left) gem_pwrite_snooped
[426.191043] [038/133] (594s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-pwrite)
[426.283732] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-pwrite
[433.789050] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-pwrite: SUCCESS (7.538s)
[433.923563] [039/133] (586s left) sriov_basic (enable-vfs-bind-unbind-each)
[433.991433] Starting subtest: enable-vfs-bind-unbind-each
[433.993369] Starting dynamic subtest: numvfs-1
[434.064450] Dynamic subtest numvfs-1: FAIL (0.005s)
[434.074190] Starting dynamic subtest: numvfs-2
[434.143724] Dynamic subtest numvfs-2: FAIL (0.003s)
[434.154120] Starting dynamic subtest: numvfs-3
[434.226386] Dynamic subtest numvfs-3: FAIL (0.003s)
[434.236382] Starting dynamic subtest: numvfs-4
[434.309173] Dynamic subtest numvfs-4: FAIL (0.003s)
[434.318395] Starting dynamic subtest: numvfs-5
[434.385835] Dynamic subtest numvfs-5: FAIL (0.004s)
[434.394865] Starting dynamic subtest: numvfs-6
[434.462623] Dynamic subtest numvfs-6: FAIL (0.004s)
[434.470977] Starting dynamic subtest: numvfs-7
[434.539304] Dynamic subtest numvfs-7: FAIL (0.004s)
[434.548824] Starting dynamic subtest: numvfs-random
[434.616882] Dynamic subtest numvfs-random: FAIL (0.004s)
[434.619016] Subtest enable-vfs-bind-unbind-each: FAIL (0.036s)
[434.654695] [040/133] (585s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-mmap-gtt)
[434.765922] Starting subtest: psr-1p-offscreen-pri-indfb-draw-mmap-gtt
[434.769398] Subtest psr-1p-offscreen-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[434.889463] [041/133] (585s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180-async-flip)
[434.989910] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180-async-flip
[434.993520] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SKIP (0.000s)
[435.123304] [042/133] (585s left) gem_mmap_gtt (hang-user)
[435.179248] Subtest hang-user: SKIP (0.000s)
[435.244591] [043/133] (585s left) gem_ctx_freq (sysfs)
[435.309881] Starting subtest: sysfs
[435.311715] Starting dynamic subtest: gt0
[440.819945] Dynamic subtest gt0: SUCCESS (5.518s)
[440.832126] Starting dynamic subtest: gt1
[482.100733] Dynamic subtest gt1: SUCCESS (41.272s)
[482.103390] Subtest sysfs: SUCCESS (46.794s)
[482.255050] [044/133] (538s left) perf (gen12-group-concurrent-oa-buffer-read)
[482.394503] Starting subtest: gen12-group-concurrent-oa-buffer-read
[492.430592] Subtest gen12-group-concurrent-oa-buffer-read: SUCCESS (10.037s)
[492.478916] [045/133] (528s left) i915_suspend (basic-s2idle-without-i915)
[492.514931] Starting subtest: basic-s2idle-without-i915
[513.313869] Subtest basic-s2idle-without-i915: SUCCESS (5.579s)
[513.444284] [046/133] (507s left) fbdev (read)
[513.498010] Starting subtest: read
[514.036990] Subtest read: SUCCESS (0.525s)
[514.078568] [047/133] (506s left) syncobj_timeline (invalid-signal-zero-handles)
[514.136862] Starting subtest: invalid-signal-zero-handles
[514.139100] Subtest invalid-signal-zero-handles: SUCCESS (0.000s)
[514.277030] [048/133] (506s left) gem_ctx_param (invalid-param-get)
[514.335559] Starting subtest: invalid-param-get
[514.337759] Subtest invalid-param-get: SUCCESS (0.002s)
[514.449325] [049/133] (506s left) kms_frontbuffer_tracking (psr-shrfb-scaledprimary)
[514.546132] Starting subtest: psr-shrfb-scaledprimary
[520.272658] Subtest psr-shrfb-scaledprimary: SUCCESS (5.834s)
[520.431344] [050/133] (500s left) gem_exec_balancer (full-late)
[520.500929] Starting subtest: full-late
[525.222778] Subtest full-late: SUCCESS (4.763s)
[525.544767] [051/133] (495s left) kms_chamelium_edid (dp-edid-stress-resolution-4k)
[525.937496] Subtest dp-edid-stress-resolution-4k: SKIP (0.000s)
[526.763988] [052/133] (494s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip)
[526.858429] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip
[526.862490] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip: SKIP (0.000s)
[526.985847] [053/133] (494s left) kms_plane (plane-position-hole-dpms)
[527.080627] Starting subtest: plane-position-hole-dpms
[527.579000] Starting dynamic subtest: pipe-A-plane-1
[529.942354] Dynamic subtest pipe-A-plane-1: SUCCESS (2.371s)
[529.952057] Starting dynamic subtest: pipe-A-plane-2
[532.292981] Dynamic subtest pipe-A-plane-2: SUCCESS (2.359s)
[532.302106] Starting dynamic subtest: pipe-A-plane-3
[534.637448] Dynamic subtest pipe-A-plane-3: SUCCESS (2.352s)
[534.648334] Starting dynamic subtest: pipe-A-plane-4
[536.927020] Dynamic subtest pipe-A-plane-4: SUCCESS (2.293s)
[536.937480] Starting dynamic subtest: pipe-A-plane-5
[536.953799] Dynamic subtest pipe-A-plane-5: SUCCESS (0.025s)
[538.114448] Starting dynamic subtest: pipe-B-plane-1
[540.445253] Dynamic subtest pipe-B-plane-1: SUCCESS (2.343s)
[540.453817] Starting dynamic subtest: pipe-B-plane-2
[542.819293] Dynamic subtest pipe-B-plane-2: SUCCESS (2.375s)
[542.828435] Starting dynamic subtest: pipe-B-plane-3
[545.179496] Dynamic subtest pipe-B-plane-3: SUCCESS (2.358s)
[545.189496] Starting dynamic subtest: pipe-B-plane-4
[547.553312] Dynamic subtest pipe-B-plane-4: SUCCESS (2.372s)
[547.563081] Starting dynamic subtest: pipe-B-plane-5
[547.579223] Dynamic subtest pipe-B-plane-5: SUCCESS (0.025s)
[547.581119] Subtest plane-position-hole-dpms: SUCCESS (20.534s)
[548.438564] [054/133] (472s left) syncobj_timeline (single-wait-available-submitted)
[548.515239] Starting subtest: single-wait-available-submitted
[548.517205] Subtest single-wait-available-submitted: SUCCESS (0.000s)
[548.651973] [055/133] (472s left) kms_psr2_sf (fbc-psr2-overlay-primary-update-sf-dmg-area)
[548.739438] Starting subtest: fbc-psr2-overlay-primary-update-sf-dmg-area
[548.741763] Starting dynamic subtest: pipe-A-eDP-1
[548.859736] Dynamic subtest pipe-A-eDP-1: SKIP (0.122s)
[548.868924] Starting dynamic subtest: pipe-B-eDP-1
[550.003756] Dynamic subtest pipe-B-eDP-1: SKIP (1.140s)
[550.008635] Subtest fbc-psr2-overlay-primary-update-sf-dmg-area: SKIP (1.265s)
[551.307345] [056/133] (469s left) kms_big_fb (4-tiled-32bpp-rotate-270)
[551.409552] Starting subtest: 4-tiled-32bpp-rotate-270
[551.432516] Subtest 4-tiled-32bpp-rotate-270: SKIP (0.023s)
[551.592117] [057/133] (469s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-mmap-wc)
[551.706236] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-mmap-wc
[551.710575] Subtest fbc-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[551.836129] [058/133] (469s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[551.942865] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[551.947116] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[552.083313] [059/133] (469s left) kms_color (ctm-0-25)
[552.175076] Starting subtest: ctm-0-25
[552.176957] Starting dynamic subtest: pipe-A-eDP-1
[555.586823] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.411s)
[555.597660] Starting dynamic subtest: pipe-B-eDP-1
[559.681469] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.096s)
[559.690932] Starting dynamic subtest: pipe-C-eDP-1
[563.639895] Dynamic subtest pipe-C-eDP-1: SUCCESS (3.956s)
[563.648851] Starting dynamic subtest: pipe-D-eDP-1
[567.643478] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.003s)
[567.645834] Subtest ctm-0-25: SUCCESS (15.469s)
[568.475056] [060/133] (452s left) kms_ccs (crc-primary-rotation-180-4-tiled-mtl-rc-ccs)
[568.575876] Starting subtest: crc-primary-rotation-180-4-tiled-mtl-rc-ccs
[568.578179] Starting dynamic subtest: pipe-A-eDP-1
[569.442995] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.861s)
[569.451996] Starting dynamic subtest: pipe-B-eDP-1
[570.959885] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.515s)
[570.970945] Starting dynamic subtest: pipe-C-eDP-1
[572.466611] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.505s)
[572.475783] Starting dynamic subtest: pipe-D-eDP-1
[573.906590] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.440s)
[573.908902] Subtest crc-primary-rotation-180-4-tiled-mtl-rc-ccs: SUCCESS (5.325s)
[575.110104] [061/133] (446s left) kms_ccs (bad-rotation-90-4-tiled-mtl-rc-ccs-cc)
[575.204884] Starting subtest: bad-rotation-90-4-tiled-mtl-rc-ccs-cc
[575.207045] Starting dynamic subtest: pipe-A-eDP-1
[575.351480] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.137s)
[575.362473] Starting dynamic subtest: pipe-B-eDP-1
[575.382273] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.009s)
[575.390900] Starting dynamic subtest: pipe-C-eDP-1
[575.410974] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.011s)
[575.419195] Starting dynamic subtest: pipe-D-eDP-1
[575.438361] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.010s)
[575.440541] Subtest bad-rotation-90-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.173s)
[577.665025] [062/133] (443s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-mmap-wc)
[577.764985] Starting subtest: psr-1p-offscreen-pri-indfb-draw-mmap-wc
[584.467793] Subtest psr-1p-offscreen-pri-indfb-draw-mmap-wc: SUCCESS (6.708s)
[584.617232] [063/133] (436s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytilercccs-downscaling)
[584.716109] Starting subtest: flip-64bpp-ytile-to-32bpp-ytilercccs-downscaling
[584.720241] Subtest flip-64bpp-ytile-to-32bpp-ytilercccs-downscaling: SKIP (0.000s)
[584.798590] [064/133] (436s left) kms_plane_multiple (2x-tiling-y)
[584.899868] Starting subtest: 2x-tiling-y
[584.904225] Subtest 2x-tiling-y: SKIP (0.000s)
[584.983851] [065/133] (436s left) vgem_basic (unload)
[585.019102] Starting subtest: unload
[614.245439] Subtest unload: SUCCESS (29.181s)
[614.303646] [066/133] (407s left) gem_exec_reloc (basic-cpu-wc)
[614.370137] Subtest basic-cpu-wc: SKIP (0.000s)
[614.461865] [067/133] (407s left) kms_plane_scaling (planes-upscale-factor-0-25)
[614.555911] Starting subtest: planes-upscale-factor-0-25
[614.558176] Starting dynamic subtest: pipe-A
[614.615664] Dynamic subtest pipe-A: SUCCESS (0.062s)
[614.626759] Starting dynamic subtest: pipe-B
[615.716766] Dynamic subtest pipe-B: SUCCESS (1.100s)
[615.728146] Starting dynamic subtest: pipe-C
[616.824662] Dynamic subtest pipe-C: SUCCESS (1.106s)
[616.836113] Starting dynamic subtest: pipe-D
[617.959185] Dynamic subtest pipe-D: SUCCESS (1.133s)
[617.961479] Subtest planes-upscale-factor-0-25: SUCCESS (3.405s)
[619.141118] [068/133] (402s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling)
[619.244850] Starting subtest: flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling
[619.249373] Subtest flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling: SKIP (0.000s)
[619.361520] [069/133] (402s left) kms_frontbuffer_tracking (fbc-1p-pri-indfb-multidraw)
[619.475464] Starting subtest: fbc-1p-pri-indfb-multidraw
[632.447602] Subtest fbc-1p-pri-indfb-multidraw: SUCCESS (12.973s)
[633.874129] [070/133] (388s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-blt)
[633.974438] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-blt
[641.129665] Subtest psr-1p-primscrn-pri-shrfb-draw-blt: SUCCESS (7.160s)
[641.278006] [071/133] (380s left) gem_set_tiling_vs_gtt
[641.407648] [072/133] (380s left) kms_selftest (drm_cmdline_parser)
[641.448368] Starting subtest: drm_cmdline_parser
[641.459858] Starting dynamic subtest: drm_test_cmdline_force_d_only
[641.593173] Dynamic subtest drm_test_cmdline_force_d_only: SUCCESS (0.131s)
[641.603012] Starting dynamic subtest: drm_test_cmdline_force_D_only_dvi
[641.739529] Dynamic subtest drm_test_cmdline_force_D_only_dvi: SUCCESS (0.146s)
[641.749877] Starting dynamic subtest: drm_test_cmdline_force_D_only_hdmi
[641.889425] Dynamic subtest drm_test_cmdline_force_D_only_hdmi: SUCCESS (0.150s)
[641.898939] Starting dynamic subtest: drm_test_cmdline_force_D_only_not_digital
[642.009531] Dynamic subtest drm_test_cmdline_force_D_only_not_digital: SUCCESS (0.120s)
[642.019699] Starting dynamic subtest: drm_test_cmdline_force_e_only
[642.148758] Dynamic subtest drm_test_cmdline_force_e_only: SUCCESS (0.134s)
[642.158866] Starting dynamic subtest: drm_test_cmdline_res
[642.283787] Dynamic subtest drm_test_cmdline_res: SUCCESS (0.134s)
[642.294068] Starting dynamic subtest: drm_test_cmdline_res_vesa
[642.426314] Dynamic subtest drm_test_cmdline_res_vesa: SUCCESS (0.142s)
[642.434370] Starting dynamic subtest: drm_test_cmdline_res_vesa_rblank
[642.553760] Dynamic subtest drm_test_cmdline_res_vesa_rblank: SUCCESS (0.126s)
[642.563802] Starting dynamic subtest: drm_test_cmdline_res_rblank
[642.687182] Dynamic subtest drm_test_cmdline_res_rblank: SUCCESS (0.132s)
[642.697764] Starting dynamic subtest: drm_test_cmdline_res_bpp
[642.809262] Dynamic subtest drm_test_cmdline_res_bpp: SUCCESS (0.122s)
[642.819676] Starting dynamic subtest: drm_test_cmdline_res_refresh
[642.932036] Dynamic subtest drm_test_cmdline_res_refresh: SUCCESS (0.122s)
[642.940761] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh
[643.060972] Dynamic subtest drm_test_cmdline_res_bpp_refresh: SUCCESS (0.128s)
[643.069249] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_interlaced
[643.194093] Dynamic subtest drm_test_cmdline_res_bpp_refresh_interlaced: SUCCESS (0.133s)
[643.202384] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_margins
[643.329955] Dynamic subtest drm_test_cmdline_res_bpp_refresh_margins: SUCCESS (0.134s)
[643.338052] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_off
[643.474938] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_off: SUCCESS (0.145s)
[643.483322] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_on
[643.595260] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_on: SUCCESS (0.119s)
[643.604202] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_on_analog
[643.684812] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_on_analog: SUCCESS (0.088s)
[643.693692] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_on_digital
[643.808149] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_on_digital: SUCCESS (0.124s)
[643.816374] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_interlaced_margins_force_on
[643.929017] Dynamic subtest drm_test_cmdline_res_bpp_refresh_interlaced_margins_force_on: SUCCESS (0.119s)
[643.937400] Starting dynamic subtest: drm_test_cmdline_res_margins_force_on
[644.054186] Dynamic subtest drm_test_cmdline_res_margins_force_on: SUCCESS (0.125s)
[644.062773] Starting dynamic subtest: drm_test_cmdline_res_vesa_margins
[644.163126] Dynamic subtest drm_test_cmdline_res_vesa_margins: SUCCESS (0.109s)
[644.171544] Starting dynamic subtest: drm_test_cmdline_name
[644.273005] Dynamic subtest drm_test_cmdline_name: SUCCESS (0.110s)
[644.281382] Starting dynamic subtest: drm_test_cmdline_name_bpp
[644.398356] Dynamic subtest drm_test_cmdline_name_bpp: SUCCESS (0.123s)
[644.409203] Starting dynamic subtest: drm_test_cmdline_name_option
[644.498862] Dynamic subtest drm_test_cmdline_name_option: SUCCESS (0.098s)
[644.509623] Starting dynamic subtest: drm_test_cmdline_name_bpp_option
[644.615723] Dynamic subtest drm_test_cmdline_name_bpp_option: SUCCESS (0.115s)
[644.626116] Starting dynamic subtest: drm_test_cmdline_rotate_0
[644.714733] Dynamic subtest drm_test_cmdline_rotate_0: SUCCESS (0.099s)
[644.724926] Starting dynamic subtest: drm_test_cmdline_rotate_90
[644.820821] Dynamic subtest drm_test_cmdline_rotate_90: SUCCESS (0.105s)
[644.830773] Starting dynamic subtest: drm_test_cmdline_rotate_180
[644.930800] Dynamic subtest drm_test_cmdline_rotate_180: SUCCESS (0.110s)
[644.939976] Starting dynamic subtest: drm_test_cmdline_rotate_270
[645.049111] Dynamic subtest drm_test_cmdline_rotate_270: SUCCESS (0.116s)
[645.059369] Starting dynamic subtest: drm_test_cmdline_hmirror
[645.163831] Dynamic subtest drm_test_cmdline_hmirror: SUCCESS (0.114s)
[645.172156] Starting dynamic subtest: drm_test_cmdline_vmirror
[645.282577] Dynamic subtest drm_test_cmdline_vmirror: SUCCESS (0.119s)
[645.291604] Starting dynamic subtest: drm_test_cmdline_margin_options
[645.389786] Dynamic subtest drm_test_cmdline_margin_options: SUCCESS (0.107s)
[645.398177] Starting dynamic subtest: drm_test_cmdline_multiple_options
[645.508349] Dynamic subtest drm_test_cmdline_multiple_options: SUCCESS (0.117s)
[645.516911] Starting dynamic subtest: drm_test_cmdline_bpp_extra_and_option
[645.613777] Dynamic subtest drm_test_cmdline_bpp_extra_and_option: SUCCESS (0.105s)
[645.622596] Starting dynamic subtest: drm_test_cmdline_extra_and_option
[645.729806] Dynamic subtest drm_test_cmdline_extra_and_option: SUCCESS (0.114s)
[645.738228] Starting dynamic subtest: drm_test_cmdline_freestanding_options
[645.837811] Dynamic subtest drm_test_cmdline_freestanding_options: SUCCESS (0.108s)
[645.846150] Starting dynamic subtest: drm_test_cmdline_freestanding_force_e_and_options
[645.953739] Dynamic subtest drm_test_cmdline_freestanding_force_e_and_options: SUCCESS (0.114s)
[645.962564] Starting dynamic subtest: drm_test_cmdline_panel_orientation
[646.069617] Dynamic subtest drm_test_cmdline_panel_orientation: SUCCESS (0.115s)
[646.078570] Starting dynamic subtest: drm_test_cmdline_invalid
[646.194613] Dynamic subtest drm_test_cmdline_invalid: SUCCESS (0.126s)
[646.202884] Starting dynamic subtest: drm_test_cmdline_tv_options
[646.307661] Dynamic subtest drm_test_cmdline_tv_options: SUCCESS (0.113s)
[646.309925] Subtest drm_cmdline_parser: SUCCESS (4.861s)
[646.497893] [073/133] (375s left) api_intel_bb (object-noreloc-keep-cache-simple)
[646.559347] Starting subtest: object-noreloc-keep-cache-simple
[646.566085] Subtest object-noreloc-keep-cache-simple: SUCCESS (0.009s)
[646.717383] [074/133] (375s left) gem_exec_schedule (pi-ringfull)
[646.901800] Starting subtest: pi-ringfull
[646.904229] Starting dynamic subtest: rcs0
[646.931117] Dynamic subtest rcs0: SUCCESS (0.034s)
[646.944744] Starting dynamic subtest: bcs0
[646.962479] Dynamic subtest bcs0: SUCCESS (0.031s)
[646.975004] Starting dynamic subtest: vcs0
[646.992993] Dynamic subtest vcs0: SUCCESS (0.030s)
[647.004602] Starting dynamic subtest: vcs1
[647.021363] Dynamic subtest vcs1: SUCCESS (0.028s)
[647.030603] Starting dynamic subtest: vecs0
[647.052331] Dynamic subtest vecs0: SUCCESS (0.030s)
[647.066168] Starting dynamic subtest: ccs0
[647.081132] Dynamic subtest ccs0: SUCCESS (0.027s)
[647.083401] Subtest pi-ringfull: SUCCESS (0.184s)
[647.334359] [075/133] (374s left) kms_psr (psr2-primary-mmap-gtt)
[647.429431] Starting subtest: psr2-primary-mmap-gtt
[647.431565] Starting dynamic subtest: eDP-1
[648.861957] Dynamic subtest eDP-1: SKIP (1.430s)
[648.867098] Subtest psr2-primary-mmap-gtt: SKIP (1.432s)
[649.045581] [076/133] (373s left) kms_flip (absolute-wf_vblank-interruptible)
[649.150747] Starting subtest: absolute-wf_vblank-interruptible
[649.153087] Starting dynamic subtest: A-eDP1
[657.885475] Dynamic subtest A-eDP1: SUCCESS (8.700s)
[657.897736] Starting dynamic subtest: B-eDP1
[666.583643] Dynamic subtest B-eDP1: SUCCESS (8.731s)
[666.593813] Starting dynamic subtest: C-eDP1
[675.350688] Dynamic subtest C-eDP1: SUCCESS (8.722s)
[675.360673] Starting dynamic subtest: D-eDP1
[684.089783] Dynamic subtest D-eDP1: SUCCESS (8.737s)
[684.091835] Subtest absolute-wf_vblank-interruptible: SUCCESS (34.903s)
[685.268795] [077/133] (336s left) kms_psr (fbc-psr-no-drrs)
[685.375662] Starting subtest: fbc-psr-no-drrs
[685.377955] Starting dynamic subtest: eDP-1
[685.382222] Dynamic subtest eDP-1: SKIP (0.000s)
[685.386611] Subtest fbc-psr-no-drrs: SKIP (0.001s)
[685.471347] [078/133] (336s left) gem_ctx_shared (single-timeline)
[685.530439] Starting subtest: single-timeline
[685.550502] Subtest single-timeline: SUCCESS (0.012s)
[685.803108] [079/133] (336s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip)
[685.903157] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip
[686.526861] Subtest x-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip: SUCCESS (0.625s)
[686.702198] [080/133] (335s left) kms_flip (flip-vs-wf_vblank-interruptible)
[686.811112] Starting subtest: flip-vs-wf_vblank-interruptible
[686.813414] Starting dynamic subtest: A-eDP1
[688.703390] Dynamic subtest A-eDP1: SUCCESS (1.891s)
[688.718381] Starting dynamic subtest: B-eDP1
[690.646770] Dynamic subtest B-eDP1: SUCCESS (1.941s)
[690.661507] Starting dynamic subtest: C-eDP1
[692.562574] Dynamic subtest C-eDP1: SUCCESS (1.915s)
[692.573411] Starting dynamic subtest: D-eDP1
[694.410698] Dynamic subtest D-eDP1: SUCCESS (1.847s)
[694.416067] Subtest flip-vs-wf_vblank-interruptible: SUCCESS (7.604s)
[695.656644] [081/133] (326s left) kms_invalid_mode (int-max-clock)
[695.756210] Starting subtest: int-max-clock
[695.758576] Starting dynamic subtest: pipe-A-eDP-1
[696.043424] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.288s)
[696.052977] Starting dynamic subtest: pipe-B-eDP-1
[696.054907] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[696.063101] Starting dynamic subtest: pipe-C-eDP-1
[696.065107] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[696.076743] Starting dynamic subtest: pipe-D-eDP-1
[696.079085] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[696.081422] Subtest int-max-clock: SUCCESS (0.295s)
[696.881103] [082/133] (325s left) kms_frontbuffer_tracking (fbc-stridechange)
[696.982547] Starting subtest: fbc-stridechange
[700.277772] Subtest fbc-stridechange: SUCCESS (3.299s)
[701.496073] [083/133] (320s left) kms_psr (psr-sprite-plane-onoff)
[701.586544] Starting subtest: psr-sprite-plane-onoff
[701.588763] Starting dynamic subtest: eDP-1
[703.409796] Dynamic subtest eDP-1: SUCCESS (1.823s)
[703.412153] Subtest psr-sprite-plane-onoff: SUCCESS (1.824s)
[704.231188] [084/133] (318s left) gem_render_copy (yf-tiled-ccs-to-y-tiled-ccs)
[704.287525] Starting subtest: yf-tiled-ccs-to-y-tiled-ccs
[704.291895] Subtest yf-tiled-ccs-to-y-tiled-ccs: SKIP (0.000s)
[704.484731] [085/133] (318s left) gem_render_copy (yf-tiled-ccs-to-yf-tiled)
[704.541766] Starting subtest: yf-tiled-ccs-to-yf-tiled
[704.546347] Subtest yf-tiled-ccs-to-yf-tiled: SKIP (0.000s)
[704.748477] [086/133] (317s left) gem_pwrite (basic-exhaustion)
[704.806865] Subtest basic-exhaustion: SKIP (0.000s)
[704.884230] [087/133] (317s left) kms_lease (setcrtc-implicit-plane)
[704.992252] Starting subtest: setcrtc-implicit-plane
[704.994571] Starting dynamic subtest: pipe-A-eDP-1
[705.477773] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.486s)
[705.486936] Starting dynamic subtest: pipe-B-eDP-1
[706.644177] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.163s)
[706.654107] Starting dynamic subtest: pipe-C-eDP-1
[707.770954] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.129s)
[707.783279] Starting dynamic subtest: pipe-D-eDP-1
[708.902851] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.127s)
[708.905276] Subtest setcrtc-implicit-plane: SUCCESS (3.913s)
[709.747892] [088/133] (312s left) kms_setmode (basic-clone-single-crtc)
[709.806083] Starting subtest: basic-clone-single-crtc
[709.812346] Subtest basic-clone-single-crtc: SKIP (0.000s)
[709.925772] [089/133] (312s left) gem_cs_tlb (engines)
[709.986443] Starting subtest: engines
[709.988336] Starting dynamic subtest: rcs0
[712.138645] Dynamic subtest rcs0: SUCCESS (2.152s)
[712.150471] Starting dynamic subtest: bcs0
[714.342180] Dynamic subtest bcs0: SUCCESS (2.151s)
[714.352282] Starting dynamic subtest: vcs0
[716.494053] Dynamic subtest vcs0: SUCCESS (2.152s)
[716.505840] Starting dynamic subtest: vcs1
[718.647485] Dynamic subtest vcs1: SUCCESS (2.153s)
[718.658957] Starting dynamic subtest: vecs0
[720.801252] Dynamic subtest vecs0: SUCCESS (2.153s)
[720.813518] Starting dynamic subtest: ccs0
[722.955546] Dynamic subtest ccs0: SUCCESS (2.153s)
[722.957948] Subtest engines: SUCCESS (12.920s)
[723.048175] [090/133] (299s left) kms_chamelium_hpd (vga-hpd-enable-disable-mode)
[723.450522] Subtest vga-hpd-enable-disable-mode: SKIP (0.000s)
[724.248671] [091/133] (298s left) kms_ccs (bad-rotation-90-y-tiled-gen12-mc-ccs)
[724.353169] Starting subtest: bad-rotation-90-y-tiled-gen12-mc-ccs
[724.355515] Starting dynamic subtest: pipe-A-eDP-1
[724.379299] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[724.390675] Starting dynamic subtest: pipe-B-eDP-1
[724.413033] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[724.421918] Starting dynamic subtest: pipe-C-eDP-1
[724.444359] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[724.454990] Starting dynamic subtest: pipe-D-eDP-1
[724.476884] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[724.480980] Subtest bad-rotation-90-y-tiled-gen12-mc-ccs: SKIP (0.004s)
[726.633972] [092/133] (296s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-fullscreen)
[726.736858] Starting subtest: psr-2p-scndscrn-spr-indfb-fullscreen
[726.740823] Subtest psr-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s)
[726.868406] [093/133] (296s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-render)
[726.980212] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-render
[726.984678] Subtest fbc-2p-scndscrn-spr-indfb-draw-render: SKIP (0.000s)
[727.115648] [094/133] (295s left) kms_addfb_basic (unused-pitches)
[727.181234] Starting subtest: unused-pitches
[727.183381] Subtest unused-pitches: SUCCESS (0.000s)
[727.362100] [095/133] (295s left) kms_content_protection (suspend-resume)
[727.517530] Starting subtest: suspend-resume
[727.521769] Subtest suspend-resume: SKIP (0.000s)
[727.662304] [096/133] (295s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-indfb-draw-mmap-gtt)
[727.760063] Starting subtest: fbc-1p-primscrn-pri-indfb-draw-mmap-gtt
[727.763605] Subtest fbc-1p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[727.890274] [097/133] (295s left) perf (i915-ref-count)
[727.975800] Starting subtest: i915-ref-count
[728.033004] Subtest i915-ref-count: SUCCESS (0.056s)
[728.088757] [098/133] (295s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-mmap-gtt)
[728.178793] Starting subtest: psr-2p-primscrn-cur-indfb-draw-mmap-gtt
[728.182098] Subtest psr-2p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[728.307540] [099/133] (294s left) kms_cursor_crc (cursor-tearing-framebuffer-change)
[728.422012] Starting subtest: cursor-tearing-framebuffer-change
[728.423782] Starting dynamic subtest: pipe-A-eDP-1
[728.977142] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.553s)
[728.987110] Starting dynamic subtest: pipe-D-eDP-1
[730.251864] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.271s)
[730.253762] Subtest cursor-tearing-framebuffer-change: SUCCESS (1.827s)
[731.118698] [100/133] (292s left) syncobj_timeline (etime-multi-wait-all-for-submit-unsubmitted-signaled)
[731.179274] Starting subtest: etime-multi-wait-all-for-submit-unsubmitted-signaled
[731.285501] Subtest etime-multi-wait-all-for-submit-unsubmitted-signaled: SUCCESS (0.106s)
[731.372597] [101/133] (291s left) gem_exec_flush (basic-wb-rw-before-default)
[731.437349] Starting subtest: basic-wb-rw-before-default
[736.920887] Subtest basic-wb-rw-before-default: SUCCESS (5.459s)
[737.091947] [102/133] (286s left) perf (disabled-read-error)
[737.181148] Starting subtest: disabled-read-error
[737.193044] Subtest disabled-read-error: SUCCESS (0.014s)
[737.240542] [103/133] (286s left) gem_spin_batch (resubmit-new-all)
[737.305379] Starting subtest: resubmit-new-all
[737.307625] Starting dynamic subtest: rcs0
[737.329836] Dynamic subtest rcs0: SUCCESS (0.024s)
[737.340654] Starting dynamic subtest: bcs0
[737.345416] Dynamic subtest bcs0: SUCCESS (0.015s)
[737.354747] Starting dynamic subtest: vcs0
[737.359947] Dynamic subtest vcs0: SUCCESS (0.014s)
[737.369253] Starting dynamic subtest: vcs1
[737.374452] Dynamic subtest vcs1: SUCCESS (0.014s)
[737.383629] Starting dynamic subtest: vecs0
[737.389380] Dynamic subtest vecs0: SUCCESS (0.014s)
[737.398738] Starting dynamic subtest: ccs0
[737.403481] Dynamic subtest ccs0: SUCCESS (0.011s)
[737.405354] Subtest resubmit-new-all: SUCCESS (0.096s)
[739.391804] [104/133] (283s left) gem_mmap_gtt (basic-small-copy)
[739.457797] Subtest basic-small-copy: SKIP (0.000s)
[739.525861] [105/133] (283s left) i915_pm_rpm (gem-idle)
[741.449389] Starting subtest: gem-idle
[747.673014] Subtest gem-idle: SUCCESS (6.214s)
[748.011091] [106/133] (275s left) drm_read (short-buffer-wakeup)
[749.376446] Starting subtest: short-buffer-wakeup
[781.650870] Subtest short-buffer-wakeup: SUCCESS (32.215s)
[781.770153] [107/133] (241s left) i915_query (query-garbage)
[781.820369] Starting subtest: query-garbage
[781.822328] Subtest query-garbage: SUCCESS (0.000s)
[781.956983] [108/133] (241s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-mmap-gtt)
[782.049959] Starting subtest: psr-2p-primscrn-pri-indfb-draw-mmap-gtt
[782.053875] Subtest psr-2p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[782.175771] [109/133] (241s left) gem_userptr_blits (usage-restrictions)
[782.248376] Starting subtest: usage-restrictions
[782.250657] Subtest usage-restrictions: SUCCESS (0.000s)
[782.397732] [110/133] (241s left) kms_pm_lpsp (screens-disabled)
[783.502105] Starting subtest: screens-disabled
[783.506309] Subtest screens-disabled: SKIP (0.000s)
[783.584008] [111/133] (240s left) i915_drm_fdinfo (virtual-busy-hang-all)
[783.628241] Starting subtest: virtual-busy-hang-all
[783.632485] Subtest virtual-busy-hang-all: SKIP (0.000s)
[783.705954] [112/133] (239s left) kms_vblank (query-idle)
[783.802936] Starting subtest: query-idle
[783.804823] Starting dynamic subtest: pipe-A-eDP-1
[785.543121] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.741s)
[785.557580] Starting dynamic subtest: pipe-D-eDP-1
[787.945805] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.399s)
[787.948119] Subtest query-idle: SUCCESS (4.144s)
[788.780408] [113/133] (234s left) i915_drm_fdinfo (all-busy-check-all)
[788.817141] Starting subtest: all-busy-check-all
[788.821397] Subtest all-busy-check-all: SKIP (0.003s)
[788.902524] [114/133] (234s left) gem_softpin (softpin)
[788.961546] Starting subtest: softpin
[821.223650] Subtest softpin: SUCCESS (32.257s)
[821.381812] [115/133] (202s left) kms_chamelium_color (ctm-green-to-red)
[821.474028] Subtest ctm-green-to-red: SKIP (0.000s)
[821.518721] [116/133] (202s left) kms_cursor_legacy (torture-move)
[821.646406] Starting subtest: torture-move
[821.648720] Starting dynamic subtest: pipe-A
[827.473362] Dynamic subtest pipe-A: SUCCESS (5.823s)
[827.483668] Starting dynamic subtest: pipe-B
[833.828429] Dynamic subtest pipe-B: SUCCESS (6.357s)
[833.845512] Starting dynamic subtest: pipe-C
[840.693191] Dynamic subtest pipe-C: SUCCESS (6.862s)
[840.706114] Starting dynamic subtest: pipe-D
[846.953109] Dynamic subtest pipe-D: SUCCESS (6.258s)
[846.964387] Starting dynamic subtest: all-pipes
[854.583884] Dynamic subtest all-pipes: SUCCESS (7.629s)
[854.586504] Subtest torture-move: SUCCESS (32.937s)
[854.759185] [117/133] (169s left) gem_exec_reloc (basic-gtt-cpu-active)
[854.827506] Subtest basic-gtt-cpu-active: SKIP (0.000s)
[854.906516] [118/133] (169s left) gem_softpin (evict-snoop)
[854.968147] Starting subtest: evict-snoop
[854.972809] Subtest evict-snoop: SKIP (0.000s)
[855.102900] [119/133] (168s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc)
[855.214272] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc
[855.218448] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[855.338138] [120/133] (168s left) gem_mmap_gtt (close-race)
[855.404508] Subtest close-race: SKIP (0.000s)
[855.477083] [121/133] (168s left) kms_ccs (crc-sprite-planes-basic-4-tiled-mtl-rc-ccs)
[855.571833] Starting subtest: crc-sprite-planes-basic-4-tiled-mtl-rc-ccs
[855.574075] Starting dynamic subtest: pipe-A-eDP-1
[856.066193] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.470s)
[856.081453] Starting dynamic subtest: pipe-B-eDP-1
[857.448774] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.377s)
[857.460754] Starting dynamic subtest: pipe-C-eDP-1
[858.851373] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.402s)
[858.862105] Starting dynamic subtest: pipe-D-eDP-1
[860.171588] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.321s)
[860.173943] Subtest crc-sprite-planes-basic-4-tiled-mtl-rc-ccs: SUCCESS (4.575s)
[861.377291] [122/133] (162s left) gem_exec_params (dr4-dirt)
[861.443061] Starting subtest: DR4-dirt
[861.445526] Subtest DR4-dirt: SUCCESS (0.000s)
[861.603754] [123/133] (162s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-render)
[861.701269] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-render
[861.705608] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-render: SKIP (0.000s)
[861.833899] [124/133] (162s left) gem_exec_whisper (basic-normal)
[861.901508] Starting subtest: basic-normal
[865.635066] Subtest basic-normal: SUCCESS (3.733s)
[865.829948] [125/133] (158s left) gem_userptr_blits (dmabuf-sync)
[865.891355] Starting subtest: dmabuf-sync
[865.896010] Subtest dmabuf-sync: SKIP (0.002s)
[866.060330] [126/133] (158s left) gem_exec_whisper (basic-sync-all)
[866.128457] Starting subtest: basic-sync-all
[873.891933] Subtest basic-sync-all: SUCCESS (7.762s)
[874.086161] [127/133] (150s left) sw_sync (alloc_fence)
[874.126205] Starting subtest: alloc_fence
[874.128403] Subtest alloc_fence: SUCCESS (0.000s)
[874.202812] [128/133] (150s left) gem_softpin (noreloc-interruptible)
[874.271409] Starting subtest: noreloc-interruptible
[879.754193] Subtest noreloc-interruptible: SUCCESS (5.430s)
[879.856098] [129/133] (144s left) gem_exec_fence (long-history)
[880.325701] Starting subtest: long-history
[887.103633] Subtest long-history: SUCCESS (6.780s)
[887.764280] [130/133] (136s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-0-async-flip)
[887.865175] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-0-async-flip
[887.869136] Subtest y-tiled-max-hw-stride-64bpp-rotate-0-async-flip: SKIP (0.000s)
[888.021324] [131/133] (136s left) kms_cursor_legacy (2x-flip-vs-cursor-atomic)
[888.145573] Starting subtest: 2x-flip-vs-cursor-atomic
[888.150102] Subtest 2x-flip-vs-cursor-atomic: SKIP (0.001s)
[888.306322] [132/133] (136s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-mmap-cpu)
[888.403292] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-mmap-cpu
[888.407591] Subtest psr-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[888.542143] [133/133] (136s left) gen9_exec_parse (bb-start-far)
[888.605871] Subtest bb-start-far: SKIP (0.000s)
[888.680152] Closing watchdogs
results: parsing output: 0/ for test: perf_pmu
results: parsing output: 1/ for test: syncobj_wait
results: parsing output: 2/ for test: gem_exec_capture
results: parsing output: 3/ for test: gem_userptr_blits
results: parsing output: 4/ for test: kms_frontbuffer_tracking
results: parsing output: 5/ for test: kms_psr
results: parsing output: 6/ for test: gem_exec_fence
results: parsing output: 7/ for test: prime_self_import
results: parsing output: 8/ for test: kms_pm_rpm
results: parsing output: 9/ for test: syncobj_timeline
results: parsing output: 10/ for test: kms_async_flips
results: parsing output: 11/ for test: kms_cursor_crc
results: parsing output: 12/ for test: kms_big_fb
results: parsing output: 13/ for test: gem_workarounds
results: parsing output: 14/ for test: gem_exec_schedule
results: parsing output: 15/ for test: syncobj_timeline
results: parsing output: 16/ for test: kms_pipe_stress
results: parsing output: 17/ for test: gem_userptr_blits
results: parsing output: 18/ for test: kms_dsc
results: parsing output: 19/ for test: kms_cursor_crc
results: parsing output: 20/ for test: kms_big_fb
results: parsing output: 21/ for test: perf
results: parsing output: 22/ for test: kms_plane
results: parsing output: 23/ for test: kms_frontbuffer_tracking
results: parsing output: 24/ for test: kms_addfb_basic
results: parsing output: 25/ for test: prime_vgem
results: parsing output: 26/ for test: kms_psr2_sf
results: parsing output: 27/ for test: perf_pmu
results: parsing output: 28/ for test: kms_cursor_legacy
results: parsing output: 29/ for test: kms_psr2_sf
results: parsing output: 30/ for test: syncobj_timeline
results: parsing output: 31/ for test: kms_psr
results: parsing output: 32/ for test: kms_frontbuffer_tracking
results: parsing output: 33/ for test: gem_ctx_shared
results: parsing output: 34/ for test: kms_flip
results: parsing output: 35/ for test: kms_cursor_legacy
results: parsing output: 36/ for test: gem_pwrite_snooped
results: parsing output: 37/ for test: kms_frontbuffer_tracking
results: parsing output: 38/ for test: sriov_basic
results: parsing output: 39/ for test: kms_frontbuffer_tracking
results: parsing output: 40/ for test: kms_big_fb
results: parsing output: 41/ for test: gem_mmap_gtt
results: parsing output: 42/ for test: gem_ctx_freq
results: parsing output: 43/ for test: perf
results: parsing output: 44/ for test: i915_suspend
results: parsing output: 45/ for test: fbdev
results: parsing output: 46/ for test: syncobj_timeline
results: parsing output: 47/ for test: gem_ctx_param
results: parsing output: 48/ for test: kms_frontbuffer_tracking
results: parsing output: 49/ for test: gem_exec_balancer
results: parsing output: 50/ for test: kms_chamelium_edid
results: parsing output: 51/ for test: kms_big_fb
results: parsing output: 52/ for test: kms_plane
results: parsing output: 53/ for test: syncobj_timeline
results: parsing output: 54/ for test: kms_psr2_sf
results: parsing output: 55/ for test: kms_big_fb
results: parsing output: 56/ for test: kms_frontbuffer_tracking
results: parsing output: 57/ for test: kms_frontbuffer_tracking
results: parsing output: 58/ for test: kms_color
results: parsing output: 59/ for test: kms_ccs
results: parsing output: 60/ for test: kms_ccs
results: parsing output: 61/ for test: kms_frontbuffer_tracking
results: parsing output: 62/ for test: kms_flip_scaled_crc
results: parsing output: 63/ for test: kms_plane_multiple
results: parsing output: 64/ for test: vgem_basic
results: parsing output: 65/ for test: gem_exec_reloc
results: parsing output: 66/ for test: kms_plane_scaling
results: parsing output: 67/ for test: kms_flip_scaled_crc
results: parsing output: 68/ for test: kms_frontbuffer_tracking
results: parsing output: 69/ for test: kms_frontbuffer_tracking
results: parsing output: 70/ for test: gem_set_tiling_vs_gtt
results: parsing output: 71/ for test: kms_selftest
results: parsing output: 72/ for test: api_intel_bb
results: parsing output: 73/ for test: gem_exec_schedule
results: parsing output: 74/ for test: kms_psr
results: parsing output: 75/ for test: kms_flip
results: parsing output: 76/ for test: kms_psr
results: parsing output: 77/ for test: gem_ctx_shared
results: parsing output: 78/ for test: kms_big_fb
results: parsing output: 79/ for test: kms_flip
results: parsing output: 80/ for test: kms_invalid_mode
results: parsing output: 81/ for test: kms_frontbuffer_tracking
results: parsing output: 82/ for test: kms_psr
results: parsing output: 83/ for test: gem_render_copy
results: parsing output: 84/ for test: gem_render_copy
results: parsing output: 85/ for test: gem_pwrite
results: parsing output: 86/ for test: kms_lease
results: parsing output: 87/ for test: kms_setmode
results: parsing output: 88/ for test: gem_cs_tlb
results: parsing output: 89/ for test: kms_chamelium_hpd
results: parsing output: 90/ for test: kms_ccs
results: parsing output: 91/ for test: kms_frontbuffer_tracking
results: parsing output: 92/ for test: kms_frontbuffer_tracking
results: parsing output: 93/ for test: kms_addfb_basic
results: parsing output: 94/ for test: kms_content_protection
results: parsing output: 95/ for test: kms_frontbuffer_tracking
results: parsing output: 96/ for test: perf
results: parsing output: 97/ for test: kms_frontbuffer_tracking
results: parsing output: 98/ for test: kms_cursor_crc
results: parsing output: 99/ for test: syncobj_timeline
results: parsing output: 100/ for test: gem_exec_flush
results: parsing output: 101/ for test: perf
results: parsing output: 102/ for test: gem_spin_batch
results: parsing output: 103/ for test: gem_mmap_gtt
results: parsing output: 104/ for test: i915_pm_rpm
results: parsing output: 105/ for test: drm_read
results: parsing output: 106/ for test: i915_query
results: parsing output: 107/ for test: kms_frontbuffer_tracking
results: parsing output: 108/ for test: gem_userptr_blits
results: parsing output: 109/ for test: kms_pm_lpsp
results: parsing output: 110/ for test: i915_drm_fdinfo
results: parsing output: 111/ for test: kms_vblank
results: parsing output: 112/ for test: i915_drm_fdinfo
results: parsing output: 113/ for test: gem_softpin
results: parsing output: 114/ for test: kms_chamelium_color
results: parsing output: 115/ for test: kms_cursor_legacy
results: parsing output: 116/ for test: gem_exec_reloc
results: parsing output: 117/ for test: gem_softpin
results: parsing output: 118/ for test: kms_frontbuffer_tracking
results: parsing output: 119/ for test: gem_mmap_gtt
results: parsing output: 120/ for test: kms_ccs
results: parsing output: 121/ for test: gem_exec_params
results: parsing output: 122/ for test: kms_frontbuffer_tracking
results: parsing output: 123/ for test: gem_exec_whisper
results: parsing output: 124/ for test: gem_userptr_blits
results: parsing output: 125/ for test: gem_exec_whisper
results: parsing output: 126/ for test: sw_sync
results: parsing output: 127/ for test: gem_softpin
results: parsing output: 128/ for test: gem_exec_fence
results: parsing output: 129/ for test: kms_big_fb
results: parsing output: 130/ for test: kms_cursor_legacy
results: parsing output: 131/ for test: kms_frontbuffer_tracking
results: parsing output: 132/ for test: gen9_exec_parse
Done.