[56.821542] Initializing watchdogs
[56.821589]   /dev/watchdog0
[56.834640] [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]
[56.838924] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[56.840906] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[56.842777] [001/130] (960s left) kms_big_fb (4-tiled-32bpp-rotate-90)
[57.037062] Starting subtest: 4-tiled-32bpp-rotate-90
[57.065726] Subtest 4-tiled-32bpp-rotate-90: SKIP (0.028s)
[57.164391] [002/130] (960s left) i915_pm_rps (fence-order)
[57.215828] Starting subtest: fence-order
[59.710703] Subtest fence-order: SUCCESS (2.510s)
[59.761450] [003/130] (957s left) gem_exec_reloc (basic-cpu-read-noreloc)
[59.826988] Subtest basic-cpu-read-noreloc: SKIP (0.000s)
[59.909371] [004/130] (957s left) kms_ccs (crc-primary-rotation-180-y-tiled-gen12-mc-ccs)
[60.013558] Starting subtest: crc-primary-rotation-180-y-tiled-gen12-mc-ccs
[60.014522] Starting dynamic subtest: pipe-A-eDP-1
[60.023244] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[60.028748] Starting dynamic subtest: pipe-B-eDP-1
[60.037149] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[60.042847] Starting dynamic subtest: pipe-C-eDP-1
[60.050987] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[60.055922] Starting dynamic subtest: pipe-D-eDP-1
[60.064253] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[60.065836] Subtest crc-primary-rotation-180-y-tiled-gen12-mc-ccs: SKIP (0.004s)
[62.480194] [005/130] (954s left) perf_pmu (busy-idle-no-semaphores)
[62.515274] Starting subtest: busy-idle-no-semaphores
[62.516189] Starting dynamic subtest: rcs0
[63.195909] Dynamic subtest rcs0: SUCCESS (0.680s)
[63.204376] Starting dynamic subtest: bcs0
[63.845806] Dynamic subtest bcs0: SUCCESS (0.651s)
[63.852765] Starting dynamic subtest: vcs0
[64.495455] Dynamic subtest vcs0: SUCCESS (0.651s)
[64.503050] Starting dynamic subtest: vcs1
[66.581938] Dynamic subtest vcs1: SUCCESS (2.091s)
[66.590120] Starting dynamic subtest: vecs0
[68.561894] Dynamic subtest vecs0: SUCCESS (1.983s)
[68.569786] Starting dynamic subtest: ccs0
[70.550906] Dynamic subtest ccs0: SUCCESS (1.991s)
[70.552528] Subtest busy-idle-no-semaphores: SUCCESS (8.051s)
[70.662572] [006/130] (946s left) gem_mmap_gtt (big-copy-odd)
[70.714699] Subtest big-copy-odd: SKIP (0.000s)
[70.766107] [007/130] (946s left) gem_exec_balancer (sliced)
[70.921029] Starting subtest: sliced
[70.923071] Subtest sliced: SKIP (0.000s)
[71.452703] [008/130] (946s left) kms_plane_scaling (plane-downscale-factor-0-5-with-modifiers)
[71.649887] Starting subtest: plane-downscale-factor-0-5-with-modifiers
[71.651084] Starting dynamic subtest: pipe-A
[71.658031] Dynamic subtest pipe-A: SKIP (0.005s)
[71.665158] Starting dynamic subtest: pipe-B
[71.682124] Dynamic subtest pipe-B: SKIP (0.024s)
[71.687587] Starting dynamic subtest: pipe-C
[71.701164] Dynamic subtest pipe-C: SKIP (0.020s)
[71.706459] Starting dynamic subtest: pipe-D
[71.718466] Dynamic subtest pipe-D: SKIP (0.017s)
[71.720246] Subtest plane-downscale-factor-0-5-with-modifiers: SKIP (0.066s)
[71.935149] [009/130] (945s left) kms_vrr (flip-basic)
[72.116731] Starting subtest: flip-basic
[72.119953] Subtest flip-basic: SKIP (0.000s)
[72.180310] [010/130] (945s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[72.288613] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[72.290440] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[72.377932] [011/130] (945s left) gem_ctx_persistence (heartbeat-close)
[72.434626] Starting subtest: heartbeat-close
[72.436664] Subtest heartbeat-close: SKIP (0.000s)
[72.527822] [012/130] (945s left) gem_pxp (create-regular-buffer)
[72.649563] Starting subtest: create-regular-buffer
[72.651069] Subtest create-regular-buffer: SUCCESS (0.000s)
[72.745160] [013/130] (944s left) kms_cursor_crc (cursor-random-512x170)
[72.997393] Starting subtest: cursor-random-512x170
[72.999393] Subtest cursor-random-512x170: SKIP (0.001s)
[73.143740] [014/130] (944s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180-hflip)
[73.252964] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180-hflip
[74.169605] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180-hflip: FAIL (0.698s)
[74.195509] [015/130] (943s left) kms_ccs (ccs-on-another-bo-y-tiled-gen12-mc-ccs)
[74.285642] Starting subtest: ccs-on-another-bo-y-tiled-gen12-mc-ccs
[74.286568] Starting dynamic subtest: pipe-A-eDP-1
[74.297094] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[74.303219] Starting dynamic subtest: pipe-B-eDP-1
[74.312257] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[74.317627] Starting dynamic subtest: pipe-C-eDP-1
[74.326042] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[74.331764] Starting dynamic subtest: pipe-D-eDP-1
[74.340468] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[74.342137] Subtest ccs-on-another-bo-y-tiled-gen12-mc-ccs: SKIP (0.002s)
[76.425207] [016/130] (941s left) kms_flip (absolute-wf_vblank-interruptible)
[76.531350] Starting subtest: absolute-wf_vblank-interruptible
[76.533317] Starting dynamic subtest: A-eDP1
[85.284450] Dynamic subtest A-eDP1: SUCCESS (8.753s)
[85.292511] Starting dynamic subtest: B-eDP1
[94.008728] Dynamic subtest B-eDP1: SUCCESS (8.724s)
[94.016032] Starting dynamic subtest: C-eDP1
[102.724366] Dynamic subtest C-eDP1: SUCCESS (8.715s)
[102.735627] Starting dynamic subtest: D-eDP1
[111.451239] Dynamic subtest D-eDP1: SUCCESS (8.723s)
[111.452239] Subtest absolute-wf_vblank-interruptible: SUCCESS (34.922s)
[112.642585] [017/130] (905s left) gem_ctx_persistence (legacy-engines-hang)
[112.693305] Starting subtest: legacy-engines-hang
[112.694165] Starting dynamic subtest: render
[112.793842] Dynamic subtest render: SUCCESS (0.100s)
[112.802808] Starting dynamic subtest: bsd1
[112.888572] Dynamic subtest bsd1: SUCCESS (0.094s)
[112.896736] Starting dynamic subtest: bsd2
[112.993707] Dynamic subtest bsd2: SUCCESS (0.104s)
[113.002651] Starting dynamic subtest: blt
[113.103590] Dynamic subtest blt: SUCCESS (0.109s)
[113.112415] Starting dynamic subtest: vebox
[113.197706] Dynamic subtest vebox: SUCCESS (0.093s)
[113.199170] Subtest legacy-engines-hang: SUCCESS (0.504s)
[113.266356] [018/130] (904s left) gem_render_copy (y-tiled-mc-ccs-to-y-tiled-ccs)
[113.327555] Starting subtest: y-tiled-mc-ccs-to-y-tiled-ccs
[113.329468] Subtest y-tiled-mc-ccs-to-y-tiled-ccs: SKIP (0.000s)
[113.500611] [019/130] (904s left) kms_addfb_basic (unused-pitches)
[113.555124] Starting subtest: unused-pitches
[113.556035] Subtest unused-pitches: SUCCESS (0.000s)
[113.700386] [020/130] (904s left) syncobj_timeline (multi-wait-signaled)
[113.742166] Starting subtest: multi-wait-signaled
[113.743182] Subtest multi-wait-signaled: SUCCESS (0.001s)
[113.836344] [021/130] (904s left) kms_psr2_sf (fbc-pr-cursor-plane-move-continuous-exceed-fully-sf)
[118.909160] Starting subtest: fbc-pr-cursor-plane-move-continuous-exceed-fully-sf
[118.911035] Subtest fbc-pr-cursor-plane-move-continuous-exceed-fully-sf: SKIP (0.002s)
[119.739767] [022/130] (898s left) kms_rotation_crc (bad-pixel-format)
[119.826494] Starting subtest: bad-pixel-format
[119.828263] Subtest bad-pixel-format: SKIP (0.001s)
[119.889011] [023/130] (898s left) gem_lmem_swapping (heavy-verify-multi-ccs)
[119.925421] Subtest heavy-verify-multi-ccs: SKIP (0.000s)
[119.964835] [024/130] (897s left) syncobj_timeline (wait-zero-handles)
[120.020858] Starting subtest: wait-zero-handles
[120.022324] Subtest wait-zero-handles: SUCCESS (0.000s)
[120.094688] [025/130] (897s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180-hflip)
[120.192441] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180-hflip
[120.194286] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180-hflip: SKIP (0.000s)
[120.298034] [026/130] (897s left) i915_hangman (gt-engine-error)
[120.358615] Starting subtest: gt-engine-error
[120.359456] Starting dynamic subtest: rcs0
[121.866478] Dynamic subtest rcs0: SUCCESS (1.505s)
[121.875621] Starting dynamic subtest: bcs0
[123.916041] Dynamic subtest bcs0: SUCCESS (2.048s)
[123.925420] Starting dynamic subtest: vcs0
[125.898088] Dynamic subtest vcs0: SUCCESS (1.982s)
[125.908088] Starting dynamic subtest: vcs1
[127.881792] Dynamic subtest vcs1: SUCCESS (1.984s)
[127.889822] Starting dynamic subtest: vecs0
[129.867148] Dynamic subtest vecs0: SUCCESS (1.985s)
[129.876480] Starting dynamic subtest: ccs0
[131.914333] Dynamic subtest ccs0: SUCCESS (2.046s)
[131.915897] Subtest gt-engine-error: SUCCESS (11.553s)
[131.985332] [027/130] (886s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-pgflip-blt)
[132.092665] Starting subtest: fbcpsr-1p-primscrn-indfb-pgflip-blt
[137.307945] Subtest fbcpsr-1p-primscrn-indfb-pgflip-blt: SUCCESS (5.217s)
[137.460237] [028/130] (880s left) api_intel_bb (simple-bb)
[137.514610] Starting subtest: simple-bb
[137.519945] Subtest simple-bb: SUCCESS (0.005s)
[137.643212] [029/130] (880s left) kms_async_flips (crc)
[137.740835] Starting subtest: crc
[138.110218] Starting dynamic subtest: pipe-A-eDP-1
[141.004875] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.895s)
[141.380409] Starting dynamic subtest: pipe-B-eDP-1
[144.223159] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.848s)
[144.582600] Starting dynamic subtest: pipe-C-eDP-1
[147.434325] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.858s)
[147.793658] Starting dynamic subtest: pipe-D-eDP-1
[150.646986] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.860s)
[150.648179] Subtest crc: SUCCESS (12.905s)
[151.822928] [030/130] (866s left) kms_ccs (bad-pixel-format-4-tiled-mtl-rc-ccs-cc)
[151.912591] Starting subtest: bad-pixel-format-4-tiled-mtl-rc-ccs-cc
[151.913585] Starting dynamic subtest: pipe-A-eDP-1
[151.921671] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s)
[151.927548] Starting dynamic subtest: pipe-B-eDP-1
[151.935592] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[151.941509] Starting dynamic subtest: pipe-C-eDP-1
[151.949094] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[151.954563] Starting dynamic subtest: pipe-D-eDP-1
[151.962342] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[151.963187] Subtest bad-pixel-format-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.004s)
[154.076279] [031/130] (864s left) kms_plane_scaling (plane-downscale-factor-0-75-with-pixel-format)
[154.174634] Starting subtest: plane-downscale-factor-0-75-with-pixel-format
[154.175551] Starting dynamic subtest: pipe-A
[155.732453] Dynamic subtest pipe-A: SUCCESS (1.557s)
[155.741121] Starting dynamic subtest: pipe-B
[158.379468] Dynamic subtest pipe-B: SUCCESS (2.646s)
[158.386027] Starting dynamic subtest: pipe-C
[159.578959] Dynamic subtest pipe-C: SUCCESS (1.200s)
[159.585538] Starting dynamic subtest: pipe-D
[160.730672] Dynamic subtest pipe-D: SUCCESS (1.151s)
[160.731681] Subtest plane-downscale-factor-0-75-with-pixel-format: SUCCESS (6.556s)
[161.890090] [032/130] (856s left) kms_psr (fbc-pr-primary-page-flip)
[162.001618] Starting subtest: fbc-pr-primary-page-flip
[162.003609] Subtest fbc-pr-primary-page-flip: SKIP (0.000s)
[162.064906] [033/130] (856s left) kms_psr (fbc-psr2-primary-mmap-cpu)
[162.163792] Starting subtest: fbc-psr2-primary-mmap-cpu
[162.164847] Starting dynamic subtest: eDP-1
[162.166686] Dynamic subtest eDP-1: SKIP (0.000s)
[162.168468] Subtest fbc-psr2-primary-mmap-cpu: SKIP (0.001s)
[162.227559] [034/130] (856s left) gem_softpin (invalid)
[162.280504] Starting subtest: invalid
[162.286940] Subtest invalid: SUCCESS (0.006s)
[162.421013] [035/130] (855s left) kms_plane_alpha_blend (coverage-vs-premult-vs-constant)
[162.516621] Starting subtest: coverage-vs-premult-vs-constant
[162.944703] Starting dynamic subtest: pipe-A-eDP-1
[163.520070] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.575s)
[163.527060] Starting dynamic subtest: pipe-D-eDP-1
[164.783589] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.260s)
[164.784648] Subtest coverage-vs-premult-vs-constant: SUCCESS (2.265s)
[165.635898] [036/130] (852s left) core_auth (basic-auth)
[165.695977] Starting subtest: basic-auth
[165.697138] Subtest basic-auth: SUCCESS (0.002s)
[165.787999] [037/130] (852s left) syncobj_wait (invalid-single-wait-unsubmitted)
[165.839684] Starting subtest: invalid-single-wait-unsubmitted
[165.840678] Subtest invalid-single-wait-unsubmitted: SUCCESS (0.000s)
[165.938753] [038/130] (852s left) kms_flip (2x-flip-vs-expired-vblank)
[166.042470] Starting subtest: 2x-flip-vs-expired-vblank
[166.053897] Subtest 2x-flip-vs-expired-vblank: SKIP (0.011s)
[166.162305] [039/130] (852s left) kms_ccs (random-ccs-data-4-tiled-dg2-mc-ccs)
[166.258758] Starting subtest: random-ccs-data-4-tiled-dg2-mc-ccs
[166.259724] Starting dynamic subtest: pipe-A-eDP-1
[166.271457] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[166.278047] Starting dynamic subtest: pipe-B-eDP-1
[166.288470] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[166.294490] Starting dynamic subtest: pipe-C-eDP-1
[166.303708] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[166.309278] Starting dynamic subtest: pipe-D-eDP-1
[166.318712] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[166.320361] Subtest random-ccs-data-4-tiled-dg2-mc-ccs: SKIP (0.003s)
[168.386325] [040/130] (850s left) kms_content_protection (dp-mst-type-0)
[168.547496] Starting subtest: dp-mst-type-0
[168.550775] Subtest dp-mst-type-0: SKIP (0.000s)
[168.682263] [041/130] (849s left) kms_feature_discovery (chamelium)
[168.779544] Starting subtest: chamelium
[168.781429] Subtest chamelium: SKIP (0.000s)
[168.843639] [042/130] (849s left) kms_scaling_modes (scaling-mode-full)
[168.940869] Starting subtest: scaling-mode-full
[168.942091] Starting dynamic subtest: pipe-A-eDP-1
[169.050530] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.109s)
[169.062633] Starting dynamic subtest: pipe-B-eDP-1
[170.223434] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.170s)
[170.234618] Starting dynamic subtest: pipe-C-eDP-1
[171.427466] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.203s)
[171.434999] Starting dynamic subtest: pipe-D-eDP-1
[172.554815] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.126s)
[172.555716] Subtest scaling-mode-full: SUCCESS (3.614s)
[173.702612] [043/130] (844s left) kms_psr (pr-sprite-mmap-gtt)
[173.806047] Starting subtest: pr-sprite-mmap-gtt
[173.807941] Subtest pr-sprite-mmap-gtt: SKIP (0.000s)
[173.869260] [044/130] (844s left) gem_softpin (reverse)
[173.933213] Starting subtest: reverse
[173.939254] Subtest reverse: SUCCESS (0.007s)
[174.057240] [045/130] (844s left) kms_pm_rpm (dpms-mode-unset-non-lpsp)
[176.094353] Starting subtest: dpms-mode-unset-non-lpsp
[177.264329] Subtest dpms-mode-unset-non-lpsp: SKIP (1.167s)
[177.615250] [046/130] (840s left) kms_cursor_crc (cursor-rapid-movement-32x10)
[177.741646] Starting subtest: cursor-rapid-movement-32x10
[177.777942] Subtest cursor-rapid-movement-32x10: SKIP (0.034s)
[178.009565] [047/130] (840s left) syncobj_wait (single-wait-submitted)
[178.062187] Starting subtest: single-wait-submitted
[178.167514] Subtest single-wait-submitted: SUCCESS (0.103s)
[178.235823] [048/130] (840s left) kms_force_connector_basic (force-edid)
[178.309285] Starting subtest: force-edid
[178.646125] Subtest force-edid: SUCCESS (0.337s)
[178.793896] [049/130] (839s left) fbdev (eof)
[178.833982] Starting subtest: eof
[178.834985] Subtest eof: SUCCESS (0.000s)
[178.887809] [050/130] (839s left) gem_exec_reloc (basic-wc-gtt)
[178.935038] Subtest basic-wc-gtt: SKIP (0.000s)
[178.993996] [051/130] (839s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-onoff)
[179.084885] Starting subtest: fbc-2p-scndscrn-cur-indfb-onoff
[179.086538] Subtest fbc-2p-scndscrn-cur-indfb-onoff: SKIP (0.000s)
[179.182818] [052/130] (839s left) gem_exec_schedule (pi-ringfull)
[179.362547] Starting subtest: pi-ringfull
[179.363664] Starting dynamic subtest: rcs0
[179.473781] Dynamic subtest rcs0: SUCCESS (0.111s)
[179.486578] Starting dynamic subtest: bcs0
[179.547818] Dynamic subtest bcs0: SUCCESS (0.073s)
[179.561406] Starting dynamic subtest: vcs0
[179.621914] Dynamic subtest vcs0: SUCCESS (0.073s)
[179.635030] Starting dynamic subtest: vcs1
[179.696977] Dynamic subtest vcs1: SUCCESS (0.074s)
[179.710462] Starting dynamic subtest: vecs0
[179.771472] Dynamic subtest vecs0: SUCCESS (0.073s)
[179.785191] Starting dynamic subtest: ccs0
[179.845837] Dynamic subtest ccs0: SUCCESS (0.073s)
[179.847549] Subtest pi-ringfull: SUCCESS (0.484s)
[180.067645] [FACT gem_exec_schedule (pi-ringfull)] new: kernel.kmod_is_loaded.vgem: true
[180.069287] [053/130] (838s left) kms_flip (2x-plain-flip-fb-recreate-interruptible)
[180.159030] Starting subtest: 2x-plain-flip-fb-recreate-interruptible
[180.171151] Subtest 2x-plain-flip-fb-recreate-interruptible: SKIP (0.011s)
[180.240529] [054/130] (838s left) kms_chamelium_frames (dp-crc-multiple)
[180.617862] Subtest dp-crc-multiple: SKIP (0.000s)
[181.402186] [055/130] (837s left) kms_chamelium_hpd (dp-hpd-enable-disable-mode)
[181.779172] Subtest dp-hpd-enable-disable-mode: SKIP (0.000s)
[182.603208] [056/130] (836s left) kms_frontbuffer_tracking (fbcpsr-shrfb-scaledprimary)
[182.703207] Starting subtest: fbcpsr-shrfb-scaledprimary
[188.394290] Subtest fbcpsr-shrfb-scaledprimary: SUCCESS (5.692s)
[188.535612] [057/130] (830s left) syncobj_timeline (etime-single-wait-for-submit-unsubmitted)
[188.590649] Starting subtest: etime-single-wait-for-submit-unsubmitted
[188.696083] Subtest etime-single-wait-for-submit-unsubmitted: SUCCESS (0.102s)
[188.763339] [058/130] (830s left) kms_plane_scaling (planes-upscale-factor-0-25-downscale-factor-0-25)
[188.850722] Starting subtest: planes-upscale-factor-0-25-downscale-factor-0-25
[188.851687] Starting dynamic subtest: pipe-A
[188.864666] Dynamic subtest pipe-A: SKIP (0.012s)
[188.873092] Starting dynamic subtest: pipe-B
[188.891648] Dynamic subtest pipe-B: SKIP (0.026s)
[188.899858] Starting dynamic subtest: pipe-C
[188.918031] Dynamic subtest pipe-C: SKIP (0.024s)
[188.931678] Starting dynamic subtest: pipe-D
[188.939559] Dynamic subtest pipe-D: SKIP (0.022s)
[188.941226] Subtest planes-upscale-factor-0-25-downscale-factor-0-25: SKIP (0.087s)
[189.044600] [059/130] (829s left) syncobj_timeline (invalid-transfer-non-existent-point)
[189.092574] Starting subtest: invalid-transfer-non-existent-point
[189.093455] Subtest invalid-transfer-non-existent-point: SUCCESS (0.000s)
[189.184494] [060/130] (829s left) kms_big_fb (linear-64bpp-rotate-270)
[189.272796] Starting subtest: linear-64bpp-rotate-270
[189.291680] Subtest linear-64bpp-rotate-270: SKIP (0.018s)
[189.409533] [061/130] (829s left) gem_exec_balancer (full-pulse)
[189.470825] Starting subtest: full-pulse
[193.667912] Subtest full-pulse: SUCCESS (4.197s)
[193.984658] [062/130] (825s left) syncobj_wait (invalid-wait-illegal-handle)
[194.037863] Starting subtest: invalid-wait-illegal-handle
[194.038983] Subtest invalid-wait-illegal-handle: SUCCESS (0.000s)
[194.148161] [063/130] (824s left) kms_flip (bo-too-big-interruptible)
[194.257168] Starting subtest: bo-too-big-interruptible
[194.259074] Starting dynamic subtest: A-eDP1
[195.988030] Dynamic subtest A-eDP1: SUCCESS (1.729s)
[195.994397] Starting dynamic subtest: B-eDP1
[197.702771] Dynamic subtest B-eDP1: SUCCESS (1.714s)
[197.711580] Starting dynamic subtest: C-eDP1
[199.403067] Dynamic subtest C-eDP1: SUCCESS (1.699s)
[199.409090] Starting dynamic subtest: D-eDP1
[201.116169] Dynamic subtest D-eDP1: SUCCESS (1.713s)
[201.119071] Subtest bo-too-big-interruptible: SUCCESS (6.862s)
[202.322144] [064/130] (816s left) gem_exec_schedule (independent)
[202.379562] Starting subtest: independent
[202.380614] Starting dynamic subtest: rcs0
[203.948580] Dynamic subtest rcs0: SUCCESS (1.566s)
[203.956206] Starting dynamic subtest: vcs0
[205.954230] Dynamic subtest vcs0: SUCCESS (2.004s)
[205.967801] Starting dynamic subtest: vcs1
[207.962357] Dynamic subtest vcs1: SUCCESS (2.006s)
[207.971962] Starting dynamic subtest: vecs0
[209.932250] Dynamic subtest vecs0: SUCCESS (1.969s)
[209.941337] Starting dynamic subtest: ccs0
[211.946817] Dynamic subtest ccs0: SUCCESS (2.013s)
[211.947936] Subtest independent: SUCCESS (9.566s)
[212.241156] [065/130] (806s left) gem_ctx_isolation (nonpriv-switch)
[212.301723] Starting subtest: nonpriv-switch
[212.303315] Starting dynamic subtest: rcs0
[212.912753] Dynamic subtest rcs0: SUCCESS (0.611s)
[212.923791] Starting dynamic subtest: bcs0
[213.591756] Dynamic subtest bcs0: SUCCESS (0.678s)
[213.600207] Starting dynamic subtest: vcs0
[214.289429] Dynamic subtest vcs0: SUCCESS (0.697s)
[214.296456] Starting dynamic subtest: vcs1
[215.605020] Dynamic subtest vcs1: SUCCESS (1.315s)
[215.613506] Starting dynamic subtest: vecs0
[217.623395] Dynamic subtest vecs0: SUCCESS (2.018s)
[217.632212] Starting dynamic subtest: ccs0
[219.562580] Dynamic subtest ccs0: SUCCESS (1.938s)
[219.563752] Subtest nonpriv-switch: SUCCESS (7.261s)
[219.812339] [066/130] (799s left) kms_frontbuffer_tracking (fbc-2p-indfb-fliptrack-mmap-gtt)
[219.916717] Starting subtest: fbc-2p-indfb-fliptrack-mmap-gtt
[219.918415] Subtest fbc-2p-indfb-fliptrack-mmap-gtt: SKIP (0.000s)
[220.035720] [067/130] (799s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-onoff)
[220.125741] Starting subtest: psr-2p-scndscrn-spr-indfb-onoff
[220.127511] Subtest psr-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s)
[220.226548] [068/130] (799s left) kms_vblank (query-busy-hang)
[220.319774] Starting subtest: query-busy-hang
[220.322404] Starting dynamic subtest: pipe-A-eDP-1
[246.690811] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.367s)
[246.700759] Starting dynamic subtest: pipe-D-eDP-1
[271.650445] Dynamic subtest pipe-D-eDP-1: SUCCESS (24.958s)
[271.651485] Subtest query-busy-hang: SUCCESS (51.329s)
[272.519815] [069/130] (746s left) kms_pipe_b_c_ivb (pipe-b-double-modeset-then-modeset-pipe-c)
[272.571439] Subtest pipe-B-double-modeset-then-modeset-pipe-C: SKIP (0.000s)
[272.633808] [070/130] (746s left) gen9_exec_parse (batch-without-end)
[272.697414] Subtest batch-without-end: SKIP (0.000s)
[272.759528] [071/130] (746s left) syncobj_wait (multi-wait-all-for-submit-submitted)
[272.811908] Starting subtest: multi-wait-all-for-submit-submitted
[272.917987] Subtest multi-wait-all-for-submit-submitted: SUCCESS (0.105s)
[272.986214] [072/130] (746s left) kms_ccs (missing-ccs-buffer-y-tiled-ccs)
[273.084762] Starting subtest: missing-ccs-buffer-y-tiled-ccs
[273.085826] Starting dynamic subtest: pipe-A-eDP-1
[273.095043] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[273.101865] Starting dynamic subtest: pipe-B-eDP-1
[273.110589] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[273.116660] Starting dynamic subtest: pipe-C-eDP-1
[273.124592] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[273.130628] Starting dynamic subtest: pipe-D-eDP-1
[273.138985] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[273.140697] Subtest missing-ccs-buffer-y-tiled-ccs: SKIP (0.004s)
[275.311733] [073/130] (744s left) gem_eio (in-flight-contexts-1us)
[275.519102] Starting subtest: in-flight-contexts-1us
[285.947871] Subtest in-flight-contexts-1us: SUCCESS (10.428s)
[286.130689] [074/130] (733s left) syncobj_basic (bad-handle-to-fd)
[286.187372] Starting subtest: bad-handle-to-fd
[286.188372] Subtest bad-handle-to-fd: SUCCESS (0.000s)
[286.291809] [075/130] (733s left) gem_mmap (basic)
[286.347036] Subtest basic: SKIP (0.000s)
[286.404793] [076/130] (733s left) kms_multipipe_modeset (basic-max-pipe-crc-check)
[286.501886] Starting subtest: basic-max-pipe-crc-check
[286.503990] Subtest basic-max-pipe-crc-check: SKIP (0.000s)
[286.543529] [077/130] (733s left) i915_suspend (debugfs-reader)
[286.600091] Starting subtest: debugfs-reader
[305.124139] Subtest debugfs-reader: SUCCESS (3.161s)
[305.185790] [078/130] (729s left) kms_psr (psr2-sprite-plane-onoff)
[305.277321] Starting subtest: psr2-sprite-plane-onoff
[305.278635] Starting dynamic subtest: eDP-1
[306.994646] Dynamic subtest eDP-1: SUCCESS (1.740s)
[306.995845] Subtest psr2-sprite-plane-onoff: SUCCESS (1.741s)
[307.790517] [079/130] (727s left) kms_frontbuffer_tracking (psr-2p-scndscrn-indfb-plflip-blt)
[307.886577] Starting subtest: psr-2p-scndscrn-indfb-plflip-blt
[307.888272] Subtest psr-2p-scndscrn-indfb-plflip-blt: SKIP (0.000s)
[307.998989] [080/130] (726s left) kms_cursor_legacy (cursorb-vs-flipb-atomic-transitions)
[308.106871] Starting subtest: cursorB-vs-flipB-atomic-transitions
[308.109333] Subtest cursorB-vs-flipB-atomic-transitions: SKIP (0.001s)
[308.202100] [081/130] (726s left) gem_pxp (verify-pxp-execution-after-suspend-resume)
[308.301902] Starting subtest: verify-pxp-execution-after-suspend-resume
[317.478335] Subtest verify-pxp-execution-after-suspend-resume: SUCCESS (9.234s)
[327.631011] [082/130] (717s left) gem_linear_blits (normal)
[328.061302] Starting subtest: normal
[332.859846] Subtest normal: SUCCESS (4.801s)
[333.061215] [083/130] (711s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc)
[333.201230] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc
[333.204034] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[333.310173] [084/130] (711s left) gem_ccs (ctrl-surf-copy)
[333.372081] Starting subtest: ctrl-surf-copy
[333.374687] Subtest ctrl-surf-copy: SKIP (0.000s)
[333.464729] [085/130] (711s left) syncobj_wait (multi-wait-all-submitted)
[333.521174] Starting subtest: multi-wait-all-submitted
[333.624031] Subtest multi-wait-all-submitted: SUCCESS (0.102s)
[333.695745] [086/130] (711s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-blt)
[333.789145] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-blt
[333.791627] Subtest fbc-2p-primscrn-pri-indfb-draw-blt: SKIP (0.000s)
[333.881032] [087/130] (711s left) kms_busy (extended-modeset-hang-oldfb-with-reset)
[333.975850] Starting subtest: extended-modeset-hang-oldfb-with-reset
[333.976963] Starting dynamic subtest: pipe-A
[345.528224] Dynamic subtest pipe-A: SUCCESS (11.560s)
[345.541401] Starting dynamic subtest: pipe-D
[357.832151] Dynamic subtest pipe-D: SUCCESS (12.308s)
[357.833118] Subtest extended-modeset-hang-oldfb-with-reset: SUCCESS (23.873s)
[358.679828] [088/130] (686s left) gem_mmap_gtt (close-race)
[358.743230] Subtest close-race: SKIP (0.000s)
[358.806432] [089/130] (686s left) gem_ctx_param (basic-default)
[358.866794] Starting subtest: basic-default
[358.868359] Subtest basic-default: SUCCESS (0.000s)
[358.935238] [090/130] (686s left) kms_flip (modeset-vs-vblank-race)
[359.025644] Starting subtest: modeset-vs-vblank-race
[359.028907] Starting dynamic subtest: A-eDP1
[363.777750] Dynamic subtest A-eDP1: SUCCESS (4.752s)
[363.788815] Starting dynamic subtest: B-eDP1
[368.474640] Dynamic subtest B-eDP1: SUCCESS (4.698s)
[368.488593] Starting dynamic subtest: C-eDP1
[373.153591] Dynamic subtest C-eDP1: SUCCESS (4.679s)
[373.164377] Starting dynamic subtest: D-eDP1
[377.847588] Dynamic subtest D-eDP1: SUCCESS (4.695s)
[377.850464] Subtest modeset-vs-vblank-race: SUCCESS (18.835s)
[379.070800] [091/130] (666s left) kms_big_fb (yf-tiled-16bpp-rotate-0)
[379.177584] Starting subtest: yf-tiled-16bpp-rotate-0
[379.179398] Subtest yf-tiled-16bpp-rotate-0: SKIP (0.000s)
[379.285714] [092/130] (666s left) kms_addfb_basic (bad-pitch-63)
[379.343282] Starting subtest: bad-pitch-63
[379.345234] Subtest bad-pitch-63: SUCCESS (0.000s)
[379.496277] [093/130] (665s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-mmap-cpu)
[379.599098] Starting subtest: fbcpsr-rgb101010-draw-mmap-cpu
[384.146844] Subtest fbcpsr-rgb101010-draw-mmap-cpu: SUCCESS (4.551s)
[384.268742] [094/130] (661s left) gem_exec_fence (syncobj-invalid-flags)
[384.710203] Starting subtest: syncobj-invalid-flags
[384.711857] Subtest syncobj-invalid-flags: SUCCESS (0.001s)
[386.390259] [095/130] (659s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-blt)
[386.488195] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-blt
[386.490352] Subtest fbc-2p-scndscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[386.603861] [096/130] (658s left) gem_exec_balancer (bonded-chain)
[386.663789] Starting subtest: bonded-chain
[393.535708] Subtest bonded-chain: SUCCESS (6.873s)
[393.841117] [097/130] (651s left) gem_exec_reloc (basic-cpu-gtt-active)
[393.893963] Subtest basic-cpu-gtt-active: SKIP (0.000s)
[393.959981] [098/130] (651s left) gem_exec_schedule (submit-early-slice)
[394.029442] Starting subtest: submit-early-slice
[394.030847] Starting dynamic subtest: rcs0
[394.091222] Dynamic subtest rcs0: SUCCESS (0.061s)
[394.100720] Starting dynamic subtest: bcs0
[394.143067] Dynamic subtest bcs0: SUCCESS (0.051s)
[394.153458] Starting dynamic subtest: vcs0
[394.207448] Dynamic subtest vcs0: SUCCESS (0.064s)
[394.217452] Starting dynamic subtest: vcs1
[394.271225] Dynamic subtest vcs1: SUCCESS (0.063s)
[394.279963] Starting dynamic subtest: vecs0
[394.336779] Dynamic subtest vecs0: SUCCESS (0.065s)
[394.348213] Starting dynamic subtest: ccs0
[394.397149] Dynamic subtest ccs0: SUCCESS (0.059s)
[394.398404] Subtest submit-early-slice: SUCCESS (0.368s)
[395.393673] [099/130] (650s left) tools_test (sysfs_l3_parity)
[395.434634] Starting subtest: sysfs_l3_parity
[395.533223] Subtest sysfs_l3_parity: SKIP (0.104s)
[395.581010] [100/130] (650s left) kms_psr (fbc-psr-sprite-mmap-gtt)
[395.687247] Starting subtest: fbc-psr-sprite-mmap-gtt
[395.688705] Starting dynamic subtest: eDP-1
[395.690831] Dynamic subtest eDP-1: SKIP (0.000s)
[395.692652] Subtest fbc-psr-sprite-mmap-gtt: SKIP (0.001s)
[395.752193] [101/130] (649s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-render)
[395.853975] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-render
[395.856219] Subtest psr-2p-primscrn-pri-shrfb-draw-render: SKIP (0.000s)
[395.967590] [102/130] (649s left) kms_big_fb (y-tiled-64bpp-rotate-270)
[396.058856] Starting subtest: y-tiled-64bpp-rotate-270
[396.060948] Subtest y-tiled-64bpp-rotate-270: SKIP (0.000s)
[396.159626] [103/130] (649s left) kms_cursor_legacy (torture-move)
[396.285564] Starting subtest: torture-move
[396.287183] Starting dynamic subtest: pipe-A
[402.519267] Dynamic subtest pipe-A: SUCCESS (6.233s)
[402.530239] Starting dynamic subtest: pipe-B
[408.884112] Dynamic subtest pipe-B: SUCCESS (6.366s)
[408.895771] Starting dynamic subtest: pipe-C
[415.063273] Dynamic subtest pipe-C: SUCCESS (6.181s)
[415.072294] Starting dynamic subtest: pipe-D
[421.519906] Dynamic subtest pipe-D: SUCCESS (6.458s)
[421.531736] Starting dynamic subtest: all-pipes
[428.395292] Dynamic subtest all-pipes: SUCCESS (6.877s)
[428.397325] Subtest torture-move: SUCCESS (32.123s)
[428.533299] [104/130] (617s left) kms_dsc (dsc-with-output-formats)
[428.619652] Starting subtest: dsc-with-output-formats
[428.628661] Subtest dsc-with-output-formats: SKIP (0.000s)
[428.689028] [105/130] (617s left) kms_psr2_sf (pr-overlay-plane-move-continuous-exceed-sf)
[433.708796] Starting subtest: pr-overlay-plane-move-continuous-exceed-sf
[433.711786] Subtest pr-overlay-plane-move-continuous-exceed-sf: SKIP (0.002s)
[434.534486] [106/130] (611s left) kms_frontbuffer_tracking (fbcpsr-1p-offscren-pri-indfb-draw-pwrite)
[434.632345] Starting subtest: fbcpsr-1p-offscren-pri-indfb-draw-pwrite
[439.712717] Subtest fbcpsr-1p-offscren-pri-indfb-draw-pwrite: SUCCESS (5.082s)
[439.853622] [107/130] (605s left) kms_joiner (switch-modeset-ultra-joiner-big-joiner)
[439.958425] Starting subtest: switch-modeset-ultra-joiner-big-joiner
[439.960543] Subtest switch-modeset-ultra-joiner-big-joiner: SKIP (0.000s)
[440.020962] [108/130] (605s left) device_reset (unbind-cold-reset-rebind)
[440.062235] Starting subtest: unbind-cold-reset-rebind
[440.064684] Subtest unbind-cold-reset-rebind: SKIP (0.000s)
[440.122755] [109/130] (605s left) syncobj_timeline (32bits-limit)
[440.172144] Starting subtest: 32bits-limit
[440.173320] Subtest 32bits-limit: SUCCESS (0.001s)
[440.276464] [110/130] (605s left) kms_hdr (bpc-switch-suspend)
[440.373588] Starting subtest: bpc-switch-suspend
[441.478811] Starting dynamic subtest: pipe-A-eDP-1
[461.164480] Dynamic subtest pipe-A-eDP-1: SUCCESS (4.494s)
[461.165585] Subtest bpc-switch-suspend: SUCCESS (5.599s)
[461.281355] [111/130] (599s left) kms_flip_scaled_crc (flip-32bpp-ytileccs-to-64bpp-ytile-upscaling)
[461.375270] Starting subtest: flip-32bpp-ytileccs-to-64bpp-ytile-upscaling
[461.376413] Starting dynamic subtest: pipe-A-default-mode
[461.672658] Dynamic subtest pipe-A-default-mode: SKIP (0.298s)
[461.674868] Subtest flip-32bpp-ytileccs-to-64bpp-ytile-upscaling: SKIP (0.300s)
[462.501850] [112/130] (598s left) syncobj_eventfd (binary-wait-before-signal)
[462.549996] Starting subtest: binary-wait-before-signal
[462.580889] Subtest binary-wait-before-signal: SUCCESS (0.031s)
[462.650203] [113/130] (598s left) gem_workarounds (suspend-resume-context)
[462.712008] Starting subtest: suspend-resume-context
[481.403646] Subtest suspend-resume-context: SUCCESS (3.503s)
[490.566842] [114/130] (594s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-move)
[490.671548] Starting subtest: fbc-2p-scndscrn-spr-indfb-move
[490.673479] Subtest fbc-2p-scndscrn-spr-indfb-move: SKIP (0.000s)
[490.780695] [115/130] (594s left) gem_exec_reloc (basic-cpu)
[490.834051] Subtest basic-cpu: SKIP (0.000s)
[490.894253] [116/130] (594s left) kms_color (ctm-0-25)
[490.992065] Starting subtest: ctm-0-25
[490.993741] Starting dynamic subtest: pipe-A-eDP-1
[494.440696] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.463s)
[494.449971] Starting dynamic subtest: pipe-B-eDP-1
[498.566448] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.138s)
[498.574680] Starting dynamic subtest: pipe-C-eDP-1
[502.486485] Dynamic subtest pipe-C-eDP-1: SUCCESS (3.928s)
[502.498074] Starting dynamic subtest: pipe-D-eDP-1
[506.380642] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.899s)
[506.381777] Subtest ctm-0-25: SUCCESS (15.429s)
[507.193647] [117/130] (578s left) gem_softpin (noreloc-interruptible)
[507.259664] Starting subtest: noreloc-interruptible
[512.676908] Subtest noreloc-interruptible: SUCCESS (5.420s)
[512.815712] [118/130] (572s left) kms_frontbuffer_tracking (psr-2p-primscrn-indfb-pgflip-blt)
[512.921312] Starting subtest: psr-2p-primscrn-indfb-pgflip-blt
[512.923210] Subtest psr-2p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[513.014838] [119/130] (572s left) kms_frontbuffer_tracking (fbc-1p-offscren-pri-shrfb-draw-mmap-gtt)
[513.113616] Starting subtest: fbc-1p-offscren-pri-shrfb-draw-mmap-gtt
[513.115890] Subtest fbc-1p-offscren-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[513.237292] [120/130] (572s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-gtt)
[513.329032] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-gtt
[513.331063] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[513.422786] [121/130] (572s left) gem_eio (throttle)
[513.758277] Starting subtest: throttle
[514.097497] Subtest throttle: SUCCESS (0.339s)
[514.230507] Aborting: Kernel badly tainted (0x240, 0x200) (check dmesg for details):
	TAINT_WARN: WARN_ON has happened.

[514.245882] [FACT gem_eio (throttle)] new: kernel.is_tainted.taint_warn: true
[514.246725] Closing watchdogs
Done.