[55.851528] Initializing watchdogs
[55.851578]   /dev/watchdog0
[55.865917] [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]
[55.871172] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[55.873481] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[55.877604] [001/156] (960s left) gem_ctx_persistence (userptr)
[55.960971] Starting subtest: userptr
[56.140877] Subtest userptr: SUCCESS (0.181s)
[56.227877] [002/156] (960s left) kms_cursor_crc (cursor-offscreen-512x170)
[56.530105] Starting subtest: cursor-offscreen-512x170
[56.534622] Subtest cursor-offscreen-512x170: SKIP (0.001s)
[56.649174] [003/156] (959s left) perf (oa-formats)
[56.768203] Starting subtest: oa-formats
[56.769972] Starting dynamic subtest: 0-rcs0
[56.780913] Dynamic subtest 0-rcs0: SUCCESS (0.014s)
[56.791348] Starting dynamic subtest: 1-vecs0
[56.802883] Dynamic subtest 1-vecs0: SUCCESS (0.022s)
[56.804841] Subtest oa-formats: SUCCESS (0.037s)
[56.848626] [004/156] (959s left) gem_mmap_gtt (cpuset-big-copy-odd)
[56.897031] Subtest cpuset-big-copy-odd: SKIP (0.000s)
[56.960219] [005/156] (959s left) kms_content_protection (uevent-hdcp14)
[57.092415] Starting subtest: uevent-hdcp14
[57.097204] Subtest uevent-hdcp14: SKIP (0.000s)
[57.221489] [006/156] (959s left) sw_sync (sync_random_merge)
[57.256513] Starting subtest: sync_random_merge
[57.300745] Subtest sync_random_merge: SUCCESS (0.044s)
[57.367543] [007/156] (959s left) kms_big_fb (linear-16bpp-rotate-0)
[57.474456] Starting subtest: linear-16bpp-rotate-0
[58.812532] Subtest linear-16bpp-rotate-0: SUCCESS (1.347s)
[58.932806] [008/156] (957s left) gem_gtt_cpu_tlb
[59.053805] [009/156] (957s left) kms_vblank (query-forked-busy)
[59.135247] Starting subtest: query-forked-busy
[59.136882] Starting dynamic subtest: pipe-A-eDP-1
[61.027780] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.902s)
[61.040096] Starting dynamic subtest: pipe-D-eDP-1
[63.632734] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.612s)
[63.634979] Subtest query-forked-busy: SUCCESS (4.517s)
[64.429232] [010/156] (952s left) kms_debugfs (display-off-read-all)
[64.528435] Starting subtest: display-off-read-all
[64.820259] Subtest display-off-read-all: SUCCESS (0.293s)
[65.667526] [011/156] (951s left) gen7_exec_parse (basic-offset)
[65.720279] Subtest basic-offset: SKIP (0.000s)
[65.781390] [012/156] (950s left) gem_render_copy (x-tiled)
[65.830702] Starting subtest: x-tiled
[65.833120] Starting dynamic subtest: smem
[65.872904] Dynamic subtest smem: SUCCESS (0.042s)
[65.875319] Subtest x-tiled: SUCCESS (0.042s)
[66.105231] [013/156] (950s left) kms_frontbuffer_tracking (hdr-1p-primscrn-cur-indfb-draw-mmap-wc)
[66.207154] Starting subtest: hdr-1p-primscrn-cur-indfb-draw-mmap-wc
[66.211107] Subtest hdr-1p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[66.322083] [014/156] (950s left) syncobj_timeline (wait-all-interrupted)
[66.368517] Starting subtest: wait-all-interrupted
[66.470927] Subtest wait-all-interrupted: SUCCESS (0.101s)
[66.557837] [015/156] (950s left) prime_vgem (basic-fence-mmap)
[66.669456] Starting subtest: basic-fence-mmap
[66.674150] Subtest basic-fence-mmap: SKIP (0.000s)
[66.792065] [FACT prime_vgem (basic-fence-mmap)] new: kernel.kmod_is_loaded.vgem: true
[66.795335] [016/156] (950s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-scndscrn-pri-shrfb-draw-mmap-gtt)
[66.894817] Starting subtest: fbcpsrhdr-2p-scndscrn-pri-shrfb-draw-mmap-gtt
[66.899294] Subtest fbcpsrhdr-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[66.992655] [017/156] (949s left) sw_sync (sync_expired_merge)
[67.023518] Starting subtest: sync_expired_merge
[68.096471] Subtest sync_expired_merge: SUCCESS (1.074s)
[68.155328] [018/156] (948s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-render)
[68.265608] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-render
[71.981033] Subtest fbc-1p-primscrn-spr-indfb-draw-render: SUCCESS (3.725s)
[73.197790] [019/156] (943s left) gen3_mixed_blits
[73.334873] [020/156] (943s left) kms_frontbuffer_tracking (fbchdr-2p-pri-indfb-multidraw)
[73.481977] Starting subtest: fbchdr-2p-pri-indfb-multidraw
[73.486556] Subtest fbchdr-2p-pri-indfb-multidraw: SKIP (0.000s)
[73.589507] [021/156] (943s left) kms_atomic_transition (modeset-transition)
[73.687737] Starting subtest: modeset-transition
[73.689875] Starting dynamic subtest: 1x-outputs
[84.780532] Dynamic subtest 1x-outputs: SUCCESS (11.097s)
[84.783079] Subtest modeset-transition: SUCCESS (11.098s)
[85.641782] [022/156] (931s left) perf_pmu (init-wait)
[85.685936] Starting subtest: init-wait
[85.688301] Starting dynamic subtest: rcs0
[85.690631] Dynamic subtest rcs0: SUCCESS (0.002s)
[85.699689] Starting dynamic subtest: bcs0
[85.701567] Dynamic subtest bcs0: SUCCESS (0.000s)
[85.708601] Starting dynamic subtest: vcs0
[85.710529] Dynamic subtest vcs0: SUCCESS (0.001s)
[85.717590] Starting dynamic subtest: vcs1
[85.719523] Dynamic subtest vcs1: SUCCESS (0.001s)
[85.726660] Starting dynamic subtest: vecs0
[85.728586] Dynamic subtest vecs0: SUCCESS (0.001s)
[85.735764] Starting dynamic subtest: ccs0
[85.737682] Dynamic subtest ccs0: SUCCESS (0.000s)
[85.739601] Subtest init-wait: SUCCESS (0.006s)
[85.807890] [023/156] (931s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-blt)
[85.903272] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-blt
[85.907588] Subtest fbc-2p-primscrn-spr-indfb-draw-blt: SKIP (0.000s)
[86.003100] [024/156] (931s left) kms_frontbuffer_tracking (hdr-2p-scndscrn-spr-indfb-fullscreen)
[86.103386] Starting subtest: hdr-2p-scndscrn-spr-indfb-fullscreen
[86.107791] Subtest hdr-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s)
[86.211676] [025/156] (931s left) gem_pxp (protected-raw-src-copy-not-readible)
[86.334539] Starting subtest: protected-raw-src-copy-not-readible
[86.390067] Subtest protected-raw-src-copy-not-readible: SUCCESS (0.058s)
[86.516382] [026/156] (930s left) kms_color (ctm-signed)
[86.603686] Starting subtest: ctm-signed
[86.605609] Starting dynamic subtest: pipe-A-eDP-1
[88.723073] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.117s)
[88.730974] Starting dynamic subtest: pipe-B-eDP-1
[91.582045] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.859s)
[91.592186] Starting dynamic subtest: pipe-C-eDP-1
[94.314106] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.732s)
[94.322997] Starting dynamic subtest: pipe-D-eDP-1
[96.978528] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.662s)
[96.980716] Subtest ctm-signed: SUCCESS (10.372s)
[97.801771] [027/156] (919s left) kms_cursor_edge_walk (128x128-right-edge)
[97.895855] Starting subtest: 128x128-right-edge
[97.898195] Starting dynamic subtest: pipe-A-eDP-1
[101.364924] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.468s)
[101.373513] Starting dynamic subtest: pipe-D-eDP-1
[104.495867] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.133s)
[104.498119] Subtest 128x128-right-edge: SUCCESS (6.602s)
[105.301344] [028/156] (912s left) kms_frontbuffer_tracking (fbc-1p-shrfb-fliptrack-mmap-gtt)
[105.406021] Starting subtest: fbc-1p-shrfb-fliptrack-mmap-gtt
[105.409926] Subtest fbc-1p-shrfb-fliptrack-mmap-gtt: SKIP (0.000s)
[105.500231] [029/156] (911s left) kms_rotation_crc (primary-yf-tiled-reflect-x-270)
[105.591988] Starting subtest: primary-yf-tiled-reflect-x-270
[105.596518] Subtest primary-yf-tiled-reflect-x-270: SKIP (0.001s)
[105.673711] [030/156] (911s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180-async-flip)
[105.778074] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180-async-flip
[106.412711] Subtest x-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SUCCESS (0.637s)
[106.587752] [031/156] (910s left) kms_frontbuffer_tracking (hdr-2p-primscrn-pri-indfb-draw-mmap-gtt)
[106.681169] Starting subtest: hdr-2p-primscrn-pri-indfb-draw-mmap-gtt
[106.685297] Subtest hdr-2p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[106.786840] [032/156] (910s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-render)
[106.879421] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-render
[106.883276] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s)
[106.978124] [033/156] (910s left) kms_ccs (bad-rotation-90-4-tiled-dg2-rc-ccs)
[107.069326] Starting subtest: bad-rotation-90-4-tiled-dg2-rc-ccs
[107.071780] Starting dynamic subtest: pipe-A-eDP-1
[107.094715] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[107.102703] Starting dynamic subtest: pipe-B-eDP-1
[107.124592] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[107.132069] Starting dynamic subtest: pipe-C-eDP-1
[107.153519] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[107.161347] Starting dynamic subtest: pipe-D-eDP-1
[107.183504] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[107.188028] Subtest bad-rotation-90-4-tiled-dg2-rc-ccs: SKIP (0.003s)
[109.366421] [034/156] (908s left) fbdev (unaligned-write)
[109.406079] Starting subtest: unaligned-write
[109.505563] Subtest unaligned-write: SUCCESS (0.099s)
[109.565976] [035/156] (908s left) gem_eio (throttle)
[109.783079] Starting subtest: throttle
[110.106217] Subtest throttle: SUCCESS (0.323s)
[110.225469] [036/156] (907s left) kms_psr (pr-cursor-mmap-cpu)
[110.308206] Starting subtest: pr-cursor-mmap-cpu
[110.311513] Subtest pr-cursor-mmap-cpu: SKIP (0.000s)
[110.389952] [037/156] (907s left) gem_mmap_offset (close-race)
[110.435437] Starting subtest: close-race
[130.543971] Subtest close-race: SUCCESS (20.108s)
[130.648886] [038/156] (887s left) kms_psr2_sf (fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf)
[130.742103] Starting subtest: fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf
[130.744431] Starting dynamic subtest: pipe-A-eDP-1
[130.830348] Dynamic subtest pipe-A-eDP-1: SKIP (0.088s)
[130.842467] Starting dynamic subtest: pipe-B-eDP-1
[131.943382] Dynamic subtest pipe-B-eDP-1: SKIP (1.113s)
[131.948098] Subtest fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf: SKIP (1.203s)
[133.132256] [039/156] (884s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-onoff)
[133.235633] Starting subtest: fbc-1p-primscrn-spr-indfb-onoff
[137.193558] Subtest fbc-1p-primscrn-spr-indfb-onoff: SUCCESS (3.964s)
[138.336154] [040/156] (879s left) gem_ctx_create (basic)
[138.401310] Starting subtest: basic
[138.403605] Subtest basic: SUCCESS (0.000s)
[138.581519] [041/156] (879s left) gem_madvise (dontneed-before-pwrite)
[138.615910] Starting subtest: dontneed-before-pwrite
[138.632987] Subtest dontneed-before-pwrite: SKIP (0.012s)
[138.693200] [042/156] (879s left) kms_psr (fbc-psr2-basic)
[138.779689] Starting subtest: fbc-psr2-basic
[138.781839] Starting dynamic subtest: eDP-1
[138.785777] Dynamic subtest eDP-1: SKIP (0.000s)
[138.789745] Subtest fbc-psr2-basic: SKIP (0.001s)
[138.848856] [043/156] (879s left) i915_drm_fdinfo (all-busy-check-all)
[138.892286] Starting subtest: all-busy-check-all
[138.899330] Subtest all-busy-check-all: SKIP (0.005s)
[138.961903] [044/156] (879s left) kms_ccs (random-ccs-data-y-tiled-gen12-mc-ccs)
[139.072849] Starting subtest: random-ccs-data-y-tiled-gen12-mc-ccs
[139.075342] Starting dynamic subtest: pipe-A-eDP-1
[139.100944] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[139.111687] Starting dynamic subtest: pipe-B-eDP-1
[139.134493] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[139.142475] Starting dynamic subtest: pipe-C-eDP-1
[139.165586] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[139.174070] Starting dynamic subtest: pipe-D-eDP-1
[139.198861] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[139.203400] Subtest random-ccs-data-y-tiled-gen12-mc-ccs: SKIP (0.003s)
[141.374313] [045/156] (876s left) kms_hdr (invalid-hdr)
[141.478121] Starting subtest: invalid-hdr
[141.480449] Starting dynamic subtest: pipe-A-eDP-1-XRGB2101010
[146.561064] Dynamic subtest pipe-A-eDP-1-XRGB2101010: SUCCESS (5.080s)
[146.577063] Starting dynamic subtest: pipe-A-eDP-1-XRGB16161616F
[150.674102] Dynamic subtest pipe-A-eDP-1-XRGB16161616F: SUCCESS (4.098s)
[150.684061] Subtest invalid-hdr: SUCCESS (9.208s)
[150.807539] [046/156] (867s left) kms_pm_backlight (fade-with-suspend)
[150.900648] Starting subtest: fade-with-suspend
[168.000680] Starting dynamic subtest: eDP-1
[171.015150] Dynamic subtest eDP-1: SUCCESS (3.049s)
[171.017856] Subtest fade-with-suspend: SUCCESS (5.516s)
[171.863975] [047/156] (846s left) gem_render_copy (y-tiled-mc-ccs-to-vebox-y-tiled)
[171.937727] Starting subtest: y-tiled-mc-ccs-to-vebox-y-tiled
[171.941977] Subtest y-tiled-mc-ccs-to-vebox-y-tiled: SKIP (0.000s)
[172.135245] [048/156] (846s left) kms_invalid_mode (bad-htotal)
[172.231259] Starting subtest: bad-htotal
[172.233540] Starting dynamic subtest: pipe-A-eDP-1
[172.510289] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.283s)
[172.520742] Starting dynamic subtest: pipe-B-eDP-1
[172.522704] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[172.532122] Starting dynamic subtest: pipe-C-eDP-1
[172.534287] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[172.543015] Starting dynamic subtest: pipe-D-eDP-1
[172.545272] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[172.547523] Subtest bad-htotal: SUCCESS (0.288s)
[173.381302] [049/156] (844s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-mmap-wc)
[173.481197] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-mmap-wc
[177.018471] Subtest fbc-1p-primscrn-cur-indfb-draw-mmap-wc: SUCCESS (3.561s)
[178.169210] [050/156] (840s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-pwrite)
[178.276354] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-pwrite
[178.280835] Subtest psr-2p-scndscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[178.384904] [051/156] (839s left) gem_exec_whisper (basic-fds-forked-all)
[178.448576] Starting subtest: basic-fds-forked-all
[198.418562] Subtest basic-fds-forked-all: SUCCESS (20.000s)
[198.600409] [052/156] (819s left) kms_frontbuffer_tracking (hdr-2p-scndscrn-cur-indfb-draw-mmap-cpu)
[198.724146] Starting subtest: hdr-2p-scndscrn-cur-indfb-draw-mmap-cpu
[198.728453] Subtest hdr-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[198.818271] [053/156] (819s left) gem_spin_batch (resubmit)
[198.880577] Starting subtest: resubmit
[198.883003] Starting dynamic subtest: rcs0
[198.887881] Dynamic subtest rcs0: SUCCESS (0.006s)
[198.906774] Starting dynamic subtest: bcs0
[198.908898] Dynamic subtest bcs0: SUCCESS (0.002s)
[198.918670] Starting dynamic subtest: vcs0
[198.920751] Dynamic subtest vcs0: SUCCESS (0.003s)
[198.930031] Starting dynamic subtest: vcs1
[198.932171] Dynamic subtest vcs1: SUCCESS (0.002s)
[198.941460] Starting dynamic subtest: vecs0
[198.943716] Dynamic subtest vecs0: SUCCESS (0.002s)
[198.953098] Starting dynamic subtest: ccs0
[198.955284] Dynamic subtest ccs0: SUCCESS (0.002s)
[198.957520] Subtest resubmit: SUCCESS (0.022s)
[199.130447] [054/156] (819s left) gem_exec_fence (syncobj-channel)
[199.640720] Starting subtest: syncobj-channel
[200.659182] Subtest syncobj-channel: SUCCESS (1.016s)
[201.018931] [055/156] (817s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-primscrn-spr-indfb-draw-blt)
[201.123089] Starting subtest: fbcpsrhdr-2p-primscrn-spr-indfb-draw-blt
[201.127122] Subtest fbcpsrhdr-2p-primscrn-spr-indfb-draw-blt: SKIP (0.000s)
[201.224864] [056/156] (817s left) syncobj_timeline (etime-multi-wait-all-submitted)
[201.283845] Starting subtest: etime-multi-wait-all-submitted
[201.386276] Subtest etime-multi-wait-all-submitted: SUCCESS (0.101s)
[201.465536] [057/156] (817s left) kms_big_fb (yf-tiled-8bpp-rotate-180)
[201.565114] Starting subtest: yf-tiled-8bpp-rotate-180
[201.569564] Subtest yf-tiled-8bpp-rotate-180: SKIP (0.000s)
[201.664363] [058/156] (816s left) gem_exec_async (forked-writes)
[201.725869] Starting subtest: forked-writes
[201.728257] Starting dynamic subtest: rcs0
[201.755304] Dynamic subtest rcs0: SUCCESS (0.029s)
[201.772365] Starting dynamic subtest: bcs0
[201.779319] Dynamic subtest bcs0: SUCCESS (0.023s)
[201.793162] Starting dynamic subtest: vcs0
[201.803739] Dynamic subtest vcs0: SUCCESS (0.023s)
[201.814195] Starting dynamic subtest: vcs1
[201.827004] Dynamic subtest vcs1: SUCCESS (0.023s)
[201.839840] Starting dynamic subtest: vecs0
[201.849278] Dynamic subtest vecs0: SUCCESS (0.021s)
[201.864265] Starting dynamic subtest: ccs0
[201.874021] Dynamic subtest ccs0: SUCCESS (0.023s)
[201.876847] Subtest forked-writes: SUCCESS (0.148s)
[202.087789] [059/156] (816s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-64bpp-yftile-downscaling)
[202.171827] Starting subtest: flip-32bpp-yftile-to-64bpp-yftile-downscaling
[202.176186] Subtest flip-32bpp-yftile-to-64bpp-yftile-downscaling: SKIP (0.000s)
[202.244870] [060/156] (816s left) syncobj_timeline (invalid-multi-wait-unsubmitted-submitted)
[202.303794] Starting subtest: invalid-multi-wait-unsubmitted-submitted
[202.306073] Subtest invalid-multi-wait-unsubmitted-submitted: SUCCESS (0.000s)
[202.427993] [061/156] (816s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-render)
[202.522097] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-render
[202.526194] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-render: SKIP (0.000s)
[202.629166] [062/156] (816s left) kms_chamelium_hpd (dp-hpd-storm)
[203.008572] Subtest dp-hpd-storm: SKIP (0.000s)
[203.840149] [063/156] (815s left) kms_big_fb (4-tiled-addfb)
[203.941953] Starting subtest: 4-tiled-addfb
[203.944225] Subtest 4-tiled-addfb: SUCCESS (0.000s)
[204.059125] [064/156] (814s left) gen7_exec_parse (oacontrol-tracking)
[204.119847] Subtest oacontrol-tracking: SKIP (0.000s)
[204.192043] [065/156] (814s left) gem_caching (reads)
[204.251302] Subtest reads: SKIP (0.000s)
[204.312241] [066/156] (814s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-plflip-blt)
[204.411450] Starting subtest: fbc-2p-primscrn-shrfb-plflip-blt
[204.415501] Subtest fbc-2p-primscrn-shrfb-plflip-blt: SKIP (0.000s)
[204.510972] [067/156] (814s left) i915_suspend (basic-s3-without-i915)
[204.544230] Starting subtest: basic-s3-without-i915
[207.899525] Subtest basic-s3-without-i915: SKIP (3.350s)
[209.456635] [068/156] (809s left) gem_create (create-ext-placement-sanity-check)
[209.636275] Starting subtest: create-ext-placement-sanity-check
[209.639237] Subtest create-ext-placement-sanity-check: SUCCESS (0.004s)
[209.750472] [069/156] (809s left) kms_ccs (crc-primary-suspend-y-tiled-gen12-rc-ccs-cc)
[209.845794] Starting subtest: crc-primary-suspend-y-tiled-gen12-rc-ccs-cc
[209.848145] Starting dynamic subtest: pipe-A-eDP-1
[209.857505] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[209.868290] Starting dynamic subtest: pipe-B-eDP-1
[209.877055] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[209.887183] Starting dynamic subtest: pipe-C-eDP-1
[209.896635] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[209.907526] Starting dynamic subtest: pipe-D-eDP-1
[209.916105] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[209.920296] Subtest crc-primary-suspend-y-tiled-gen12-rc-ccs-cc: SKIP (0.004s)
[212.121793] [070/156] (807s left) kms_frontbuffer_tracking (fbchdr-2p-scndscrn-pri-indfb-draw-render)
[212.222027] Starting subtest: fbchdr-2p-scndscrn-pri-indfb-draw-render
[212.226665] Subtest fbchdr-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s)
[212.356571] [071/156] (806s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-render)
[212.447117] Starting subtest: psr-1p-offscreen-pri-indfb-draw-render
[219.578498] Subtest psr-1p-offscreen-pri-indfb-draw-render: SUCCESS (7.139s)
[219.716258] [072/156] (799s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-move)
[219.811289] Starting subtest: psr-2p-scndscrn-spr-indfb-move
[219.815699] Subtest psr-2p-scndscrn-spr-indfb-move: SKIP (0.000s)
[219.911660] [073/156] (799s left) kms_cursor_legacy (2x-cursor-vs-flip-atomic)
[220.019256] Starting subtest: 2x-cursor-vs-flip-atomic
[220.023732] Subtest 2x-cursor-vs-flip-atomic: SKIP (0.001s)
[220.173748] [074/156] (799s left) prime_vgem (basic-read)
[220.235239] Starting subtest: basic-read
[220.243835] Subtest basic-read: SKIP (0.006s)
[220.345170] [075/156] (799s left) kms_draw_crc (draw-method-render)
[220.428771] Starting subtest: draw-method-render
[220.430632] Starting dynamic subtest: xrgb8888-untiled
[220.659754] Dynamic subtest xrgb8888-untiled: SUCCESS (0.232s)
[220.669038] Starting dynamic subtest: rgb565-untiled
[220.893103] Dynamic subtest rgb565-untiled: SUCCESS (0.233s)
[220.902579] Starting dynamic subtest: xrgb2101010-untiled
[221.104214] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.210s)
[221.113967] Starting dynamic subtest: xbgr16161616f-untiled
[221.348470] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.244s)
[221.359289] Starting dynamic subtest: xrgb8888-xtiled
[221.481721] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.131s)
[221.491648] Starting dynamic subtest: rgb565-xtiled
[221.603804] Dynamic subtest rgb565-xtiled: SUCCESS (0.122s)
[221.613788] Starting dynamic subtest: xrgb2101010-xtiled
[221.714804] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.110s)
[221.724197] Starting dynamic subtest: xbgr16161616f-xtiled
[221.848140] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.132s)
[221.858505] Starting dynamic subtest: xrgb8888-4tiled
[221.981624] Dynamic subtest xrgb8888-4tiled: SUCCESS (0.132s)
[221.992436] Starting dynamic subtest: rgb565-4tiled
[222.115799] Dynamic subtest rgb565-4tiled: SUCCESS (0.133s)
[222.127499] Starting dynamic subtest: xrgb2101010-4tiled
[222.225487] Dynamic subtest xrgb2101010-4tiled: SUCCESS (0.107s)
[222.236964] Starting dynamic subtest: xbgr16161616f-4tiled
[222.358709] Dynamic subtest xbgr16161616f-4tiled: SUCCESS (0.131s)
[222.360678] Subtest draw-method-render: SUCCESS (1.933s)
[222.440470] [076/156] (796s left) kms_frontbuffer_tracking (fbcpsr-tiling-y)
[222.545521] Starting subtest: fbcpsr-tiling-y
[222.549047] Subtest fbcpsr-tiling-y: SKIP (0.000s)
[222.638178] [077/156] (796s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-blt)
[222.736859] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-blt
[229.702878] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-blt: SUCCESS (6.972s)
[229.860763] [078/156] (789s left) gem_exec_balancer (nop)
[229.927307] Starting subtest: nop
[276.613291] Subtest nop: SUCCESS (46.673s)
[276.928000] [079/156] (742s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-blt)
[277.045574] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-blt
[277.050178] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-blt: SKIP (0.000s)
[277.135926] [080/156] (742s left) kms_flip_scaled_crc (flip-64bpp-yftile-to-32bpp-yftile-downscaling)
[277.235036] Starting subtest: flip-64bpp-yftile-to-32bpp-yftile-downscaling
[277.239533] Subtest flip-64bpp-yftile-to-32bpp-yftile-downscaling: SKIP (0.000s)
[277.308037] [081/156] (742s left) gem_ctx_isolation (dirty-switch)
[277.360724] Starting subtest: dirty-switch
[277.363068] Starting dynamic subtest: rcs0
[277.584003] Dynamic subtest rcs0: SUCCESS (0.222s)
[277.598033] Starting dynamic subtest: bcs0
[277.829144] Dynamic subtest bcs0: SUCCESS (0.243s)
[277.838176] Starting dynamic subtest: vcs0
[278.065751] Dynamic subtest vcs0: SUCCESS (0.237s)
[278.074910] Starting dynamic subtest: vcs1
[280.135996] Dynamic subtest vcs1: SUCCESS (2.066s)
[280.146173] Starting dynamic subtest: vecs0
[282.178024] Dynamic subtest vecs0: SUCCESS (2.039s)
[282.188001] Starting dynamic subtest: ccs0
[284.167561] Dynamic subtest ccs0: SUCCESS (1.987s)
[284.169992] Subtest dirty-switch: SUCCESS (6.800s)
[284.405165] [082/156] (735s left) kms_frontbuffer_tracking (psr-1p-primscrn-indfb-plflip-blt)
[284.517892] Starting subtest: psr-1p-primscrn-indfb-plflip-blt
[291.868894] Subtest psr-1p-primscrn-indfb-plflip-blt: SUCCESS (7.353s)
[292.006272] [083/156] (727s left) kms_cursor_crc (cursor-rapid-movement-max-size)
[292.293627] Starting subtest: cursor-rapid-movement-max-size
[292.300415] Subtest cursor-rapid-movement-max-size: SKIP (0.000s)
[292.440686] [084/156] (727s left) core_getclient (basic)
[292.491074] Starting subtest: basic
[292.493356] Subtest basic: SUCCESS (0.000s)
[292.599389] [085/156] (727s left) kms_addfb_basic (unused-modifier)
[292.650045] Starting subtest: unused-modifier
[292.651997] Subtest unused-modifier: SUCCESS (0.000s)
[292.795058] [086/156] (727s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-onoff)
[292.890767] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-onoff
[299.895777] Subtest fbcpsr-1p-primscrn-cur-indfb-onoff: SUCCESS (7.007s)
[300.055395] [087/156] (719s left) kms_busy (basic-hang)
[300.158633] Starting subtest: basic-hang
[300.160910] Starting dynamic subtest: flip-pipe-A
[300.750612] Dynamic subtest flip-pipe-A: SUCCESS (0.592s)
[300.761006] Starting dynamic subtest: modeset-pipe-A
[304.165839] Dynamic subtest modeset-pipe-A: SUCCESS (3.411s)
[304.178010] Starting dynamic subtest: flip-pipe-D
[305.402838] Dynamic subtest flip-pipe-D: SUCCESS (1.235s)
[305.412926] Starting dynamic subtest: modeset-pipe-D
[308.808220] Dynamic subtest modeset-pipe-D: SUCCESS (3.404s)
[308.810578] Subtest basic-hang: SUCCESS (8.648s)
[309.621154] [088/156] (710s left) syncobj_basic (bad-handle-to-fd)
[309.671001] Starting subtest: bad-handle-to-fd
[309.673076] Subtest bad-handle-to-fd: SUCCESS (0.000s)
[309.771918] [089/156] (710s left) syncobj_timeline (multi-wait-all-for-submit-available-signaled)
[309.827703] Starting subtest: multi-wait-all-for-submit-available-signaled
[309.830066] Subtest multi-wait-all-for-submit-available-signaled: SUCCESS (0.000s)
[309.934670] [090/156] (710s left) gem_exec_schedule (implicit-write-read)
[310.004824] Starting subtest: implicit-write-read
[310.007170] Starting dynamic subtest: rcs0
[310.113100] Dynamic subtest rcs0: SUCCESS (0.120s)
[310.127892] Starting dynamic subtest: vcs0
[310.198664] Dynamic subtest vcs0: SUCCESS (0.085s)
[310.210436] Starting dynamic subtest: vcs1
[310.281968] Dynamic subtest vcs1: SUCCESS (0.080s)
[310.295554] Starting dynamic subtest: vecs0
[310.354782] Dynamic subtest vecs0: SUCCESS (0.072s)
[310.369168] Starting dynamic subtest: ccs0
[310.432915] Dynamic subtest ccs0: SUCCESS (0.077s)
[310.435772] Subtest implicit-write-read: SUCCESS (0.440s)
[312.012923] [091/156] (708s left) gem_lmem_swapping (heavy-random)
[312.056918] Subtest heavy-random: SKIP (0.000s)
[312.102782] [092/156] (708s left) kms_plane (pixel-format-y-tiled-modifier-source-clamping)
[312.201966] Starting subtest: pixel-format-y-tiled-modifier-source-clamping
[312.205980] Subtest pixel-format-y-tiled-modifier-source-clamping: SKIP (0.000s)
[312.282808] [093/156] (707s left) gem_userptr_blits (sync-unmap)
[312.349762] Starting subtest: sync-unmap
[312.362985] Subtest sync-unmap: SUCCESS (0.014s)
[312.492480] [094/156] (707s left) kms_chamelium_edid (hdmi-mode-timings)
[312.862562] Subtest hdmi-mode-timings: SKIP (0.000s)
[313.729553] [095/156] (706s left) kms_frontbuffer_tracking (hdr-2p-primscrn-cur-indfb-move)
[313.836432] Starting subtest: hdr-2p-primscrn-cur-indfb-move
[313.840835] Subtest hdr-2p-primscrn-cur-indfb-move: SKIP (0.000s)
[313.934719] [096/156] (706s left) sw_sync (alloc_timeline)
[313.969537] Starting subtest: alloc_timeline
[313.972127] Subtest alloc_timeline: SUCCESS (0.000s)
[314.021307] [097/156] (706s left) i915_pm_freq_mult (media-freq)
[314.065099] Starting subtest: media-freq
[314.067316] Starting dynamic subtest: gt0
[314.071313] Dynamic subtest gt0: SKIP (0.000s)
[314.080458] Starting dynamic subtest: gt1
[314.084570] Dynamic subtest gt1: SKIP (0.000s)
[314.088715] Subtest media-freq: SKIP (0.001s)
[314.155765] [098/156] (706s left) sysfs_timeslice_duration (duration)
[314.216396] Starting subtest: duration
[314.218756] Starting dynamic subtest: vecs0
[327.877014] Dynamic subtest vecs0: SUCCESS (13.658s)
[327.889519] Starting dynamic subtest: ccs0
[341.024023] Dynamic subtest ccs0: SUCCESS (13.143s)
[341.037772] Starting dynamic subtest: vcs0
[354.820651] Dynamic subtest vcs0: SUCCESS (13.791s)
[354.832775] Starting dynamic subtest: bcs0
[367.953360] Dynamic subtest bcs0: SUCCESS (13.130s)
[367.967603] Starting dynamic subtest: rcs0
[381.101207] Dynamic subtest rcs0: SUCCESS (13.146s)
[381.112887] Starting dynamic subtest: vcs1
[395.846463] Dynamic subtest vcs1: SUCCESS (14.741s)
[395.849484] Subtest duration: SUCCESS (81.625s)
[395.922323] [099/156] (624s left) kms_rotation_crc (multiplane-rotation)
[396.032890] Starting subtest: multiplane-rotation
[413.446419] Subtest multiplane-rotation: SUCCESS (17.415s)
[413.546308] [100/156] (606s left) kms_pm_rpm (legacy-planes-dpms)
[415.072149] Starting subtest: legacy-planes-dpms
[415.074247] Starting dynamic subtest: plane-65
[423.483039] Dynamic subtest plane-65: SUCCESS (8.413s)
[423.493786] Starting dynamic subtest: plane-95
[431.841343] Dynamic subtest plane-95: SUCCESS (8.356s)
[431.853713] Starting dynamic subtest: plane-125
[440.466917] Dynamic subtest plane-125: SUCCESS (8.623s)
[440.479766] Starting dynamic subtest: plane-135
[448.779712] Dynamic subtest plane-135: SUCCESS (8.310s)
[448.782484] Subtest legacy-planes-dpms: SUCCESS (33.713s)
[449.173822] [101/156] (571s left) kms_lease (simple-lease)
[449.263676] Starting subtest: simple-lease
[449.265974] Starting dynamic subtest: pipe-A-eDP-1
[449.776997] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.512s)
[449.792222] Starting dynamic subtest: pipe-B-eDP-1
[451.210271] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.432s)
[451.223021] Starting dynamic subtest: pipe-C-eDP-1
[452.712018] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.500s)
[452.721619] Starting dynamic subtest: pipe-D-eDP-1
[454.126288] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.413s)
[454.128648] Subtest simple-lease: SUCCESS (4.864s)
[454.941150] [102/156] (565s left) kms_psr2_sf (pr-cursor-plane-move-continuous-sf)
[455.048086] Starting subtest: pr-cursor-plane-move-continuous-sf
[455.052296] Subtest pr-cursor-plane-move-continuous-sf: SKIP (0.000s)
[455.134451] [103/156] (565s left) kms_ccs (crc-sprite-planes-basic-4-tiled-mtl-rc-ccs)
[455.224246] Starting subtest: crc-sprite-planes-basic-4-tiled-mtl-rc-ccs
[455.226487] Starting dynamic subtest: pipe-A-eDP-1
[455.692129] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.440s)
[455.704523] Starting dynamic subtest: pipe-B-eDP-1
[457.050265] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.357s)
[457.062176] Starting dynamic subtest: pipe-C-eDP-1
[458.450957] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.397s)
[458.463348] Starting dynamic subtest: pipe-D-eDP-1
[459.815962] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.366s)
[459.817916] Subtest crc-sprite-planes-basic-4-tiled-mtl-rc-ccs: SUCCESS (4.565s)
[460.970065] [104/156] (559s left) gem_pxp (create-protected-buffer)
[461.102229] Starting subtest: create-protected-buffer
[461.104750] Subtest create-protected-buffer: SUCCESS (0.000s)
[461.221838] [105/156] (559s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-primscrn-indfb-pgflip-blt)
[461.322912] Starting subtest: fbcpsrhdr-1p-primscrn-indfb-pgflip-blt
[461.327252] Subtest fbcpsrhdr-1p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[461.417707] [106/156] (559s left) kms_psr (psr2-sprite-mmap-cpu)
[461.502891] Starting subtest: psr2-sprite-mmap-cpu
[461.505221] Starting dynamic subtest: eDP-1
[463.275011] Dynamic subtest eDP-1: SUCCESS (1.770s)
[463.277363] Subtest psr2-sprite-mmap-cpu: SUCCESS (1.771s)
[464.141458] [107/156] (556s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-blt)
[464.243581] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-blt
[468.689039] Subtest fbc-1p-primscrn-pri-shrfb-draw-blt: SUCCESS (4.451s)
[469.846416] [108/156] (550s left) gem_madvise (dontneed-before-mmap)
[469.886610] Starting subtest: dontneed-before-mmap
[469.905577] Subtest dontneed-before-mmap: SUCCESS (0.022s)
[470.024468] [109/156] (550s left) kms_flip (2x-flip-vs-panning-vs-hang)
[470.105688] Starting subtest: 2x-flip-vs-panning-vs-hang
[470.110272] Subtest 2x-flip-vs-panning-vs-hang: SKIP (0.002s)
[470.227794] [110/156] (550s left) gem_userptr_blits (map-fixed-invalidate-overlap)
[470.287901] Starting subtest: map-fixed-invalidate-overlap
[470.292251] Subtest map-fixed-invalidate-overlap: SKIP (0.000s)
[470.411436] [111/156] (550s left) kms_flip (blocking-wf_vblank)
[470.499392] Starting subtest: blocking-wf_vblank
[470.501845] Starting dynamic subtest: A-eDP1
[479.491401] Dynamic subtest A-eDP1: SUCCESS (8.990s)
[479.502904] Starting dynamic subtest: B-eDP1
[488.414410] Dynamic subtest B-eDP1: SUCCESS (8.920s)
[488.424579] Starting dynamic subtest: C-eDP1
[497.341370] Dynamic subtest C-eDP1: SUCCESS (8.923s)
[497.352780] Starting dynamic subtest: D-eDP1
[506.274994] Dynamic subtest D-eDP1: SUCCESS (8.932s)
[506.280651] Subtest blocking-wf_vblank: SUCCESS (35.779s)
[507.518221] [112/156] (513s left) kms_plane_multiple (tiling-y)
[507.613773] Starting subtest: tiling-y
[507.618154] Subtest tiling-y: SKIP (0.000s)
[507.694297] [113/156] (513s left) drm_mm (drm_mm)
[507.728473] Starting subtest: drm_mm
[507.765345] Starting dynamic subtest: drm_test_mm_init
[507.874093] Dynamic subtest drm_test_mm_init: SUCCESS (0.106s)
[507.885354] Starting dynamic subtest: drm_test_mm_debug
[507.968127] Dynamic subtest drm_test_mm_debug: SUCCESS (0.094s)
[507.978778] Starting dynamic subtest: drm_test_mm_align32
[508.062102] Dynamic subtest drm_test_mm_align32: SUCCESS (0.095s)
[508.072665] Starting dynamic subtest: drm_test_mm_align64
[508.167823] Dynamic subtest drm_test_mm_align64: SUCCESS (0.106s)
[508.179421] Starting dynamic subtest: drm_test_mm_lowest
[508.274008] Dynamic subtest drm_test_mm_lowest: SUCCESS (0.104s)
[508.284392] Starting dynamic subtest: drm_test_mm_highest
[508.371007] Dynamic subtest drm_test_mm_highest: SUCCESS (0.097s)
[508.373143] Subtest drm_mm: SUCCESS (0.643s)
[508.547510] [114/156] (512s left) kms_psr (pr-sprite-mmap-cpu)
[508.634360] Starting subtest: pr-sprite-mmap-cpu
[508.638903] Subtest pr-sprite-mmap-cpu: SKIP (0.000s)
[508.706785] [115/156] (512s left) kms_addfb_basic (legacy-format)
[508.763354] Starting subtest: legacy-format
[508.791035] Subtest legacy-format: SUCCESS (0.024s)
[508.931667] [116/156] (512s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-pgflip-blt)
[509.025745] Starting subtest: fbc-1p-primscrn-shrfb-pgflip-blt
[513.561616] Subtest fbc-1p-primscrn-shrfb-pgflip-blt: SUCCESS (4.540s)
[514.727475] [117/156] (506s left) kms_flip (2x-blocking-absolute-wf_vblank-interruptible)
[514.825954] Starting subtest: 2x-blocking-absolute-wf_vblank-interruptible
[514.838131] Subtest 2x-blocking-absolute-wf_vblank-interruptible: SKIP (0.011s)
[514.937305] [118/156] (506s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-offscreen-pri-shrfb-draw-pwrite)
[515.046500] Starting subtest: fbcpsrhdr-1p-offscreen-pri-shrfb-draw-pwrite
[515.050732] Subtest fbcpsrhdr-1p-offscreen-pri-shrfb-draw-pwrite: SKIP (0.000s)
[515.162633] [119/156] (506s left) kms_big_fb (linear-max-hw-stride-64bpp-rotate-0-hflip)
[515.265042] Starting subtest: linear-max-hw-stride-64bpp-rotate-0-hflip
[515.269344] Subtest linear-max-hw-stride-64bpp-rotate-0-hflip: SKIP (0.000s)
[515.372053] [120/156] (505s left) perf_pmu (busy)
[515.412539] Starting subtest: busy
[515.414820] Starting dynamic subtest: rcs0
[515.999732] Dynamic subtest rcs0: SUCCESS (0.589s)
[516.012396] Starting dynamic subtest: bcs0
[516.563694] Dynamic subtest bcs0: SUCCESS (0.562s)
[516.580496] Starting dynamic subtest: vcs0
[517.926984] Dynamic subtest vcs0: SUCCESS (1.359s)
[517.940773] Starting dynamic subtest: vcs1
[519.911758] Dynamic subtest vcs1: SUCCESS (1.982s)
[519.923584] Starting dynamic subtest: vecs0
[521.958870] Dynamic subtest vecs0: SUCCESS (2.044s)
[521.971596] Starting dynamic subtest: ccs0
[522.531471] Dynamic subtest ccs0: SUCCESS (0.571s)
[522.533953] Subtest busy: SUCCESS (7.122s)
[522.646607] [121/156] (498s left) kms_cursor_legacy (long-nonblocking-modeset-vs-cursor-atomic)
[522.764835] Starting subtest: long-nonblocking-modeset-vs-cursor-atomic
[540.913606] Subtest long-nonblocking-modeset-vs-cursor-atomic: SUCCESS (18.147s)
[541.795179] [122/156] (479s left) kms_frontbuffer_tracking (fbcpsr-2p-rte)
[541.896602] Starting subtest: fbcpsr-2p-rte
[541.901009] Subtest fbcpsr-2p-rte: SKIP (0.000s)
[541.985151] [123/156] (479s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-primscrn-cur-indfb-draw-blt)
[542.081235] Starting subtest: fbcpsrhdr-2p-primscrn-cur-indfb-draw-blt
[542.085458] Subtest fbcpsrhdr-2p-primscrn-cur-indfb-draw-blt: SKIP (0.000s)
[542.195164] [124/156] (479s left) gem_exec_balancer (parallel-keep-in-fence)
[542.450883] Starting subtest: parallel-keep-in-fence
[543.540058] Subtest parallel-keep-in-fence: SUCCESS (1.089s)
[543.666908] [125/156] (477s left) kms_frontbuffer_tracking (fbcpsrhdr-rgb565-draw-mmap-wc)
[543.773331] Starting subtest: fbcpsrhdr-rgb565-draw-mmap-wc
[543.777823] Subtest fbcpsrhdr-rgb565-draw-mmap-wc: SKIP (0.000s)
[543.891373] [126/156] (477s left) kms_plane (plane-panning-bottom-right-suspend)
[543.986268] Starting subtest: plane-panning-bottom-right-suspend
[543.988176] Starting dynamic subtest: pipe-A
[561.390729] Dynamic subtest pipe-A: SUCCESS (2.865s)
[561.401724] Starting dynamic subtest: pipe-B
[580.363786] Dynamic subtest pipe-B: SUCCESS (3.486s)
[580.366886] Subtest plane-panning-bottom-right-suspend: SUCCESS (6.355s)
[581.178043] [127/156] (440s left) kms_psr2_su (page_flip-nv12)
[581.237371] Subtest page_flip-NV12: SKIP (0.000s)
[581.300428] [128/156] (440s left) kms_vrr (flip-basic-fastset)
[581.386579] Starting subtest: flip-basic-fastset
[581.393762] Subtest flip-basic-fastset: SKIP (0.000s)
[581.462916] [129/156] (440s left) kms_cursor_legacy (2x-cursor-vs-flip-legacy)
[581.580618] Starting subtest: 2x-cursor-vs-flip-legacy
[581.585654] Subtest 2x-cursor-vs-flip-legacy: SKIP (0.001s)
[581.724511] [130/156] (440s left) kms_frontbuffer_tracking (psrhdr-1p-primscrn-cur-indfb-draw-blt)
[581.822808] Starting subtest: psrhdr-1p-primscrn-cur-indfb-draw-blt
[581.828418] Subtest psrhdr-1p-primscrn-cur-indfb-draw-blt: SKIP (0.000s)
[581.920496] [131/156] (439s left) kms_ccs (bad-rotation-90-y-tiled-gen12-mc-ccs)
[582.015641] Starting subtest: bad-rotation-90-y-tiled-gen12-mc-ccs
[582.018106] Starting dynamic subtest: pipe-A-eDP-1
[582.043255] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[582.054900] Starting dynamic subtest: pipe-B-eDP-1
[582.080365] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[582.090114] Starting dynamic subtest: pipe-C-eDP-1
[582.112067] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[582.121469] Starting dynamic subtest: pipe-D-eDP-1
[582.142723] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[582.147251] Subtest bad-rotation-90-y-tiled-gen12-mc-ccs: SKIP (0.004s)
[584.310743] [132/156] (437s left) sw_sync (sync_merge)
[584.341890] Starting subtest: sync_merge
[584.343672] Subtest sync_merge: SUCCESS (0.000s)
[584.396242] [133/156] (437s left) kms_frontbuffer_tracking (fbchdr-1p-primscrn-spr-indfb-draw-pwrite)
[584.497537] Starting subtest: fbchdr-1p-primscrn-spr-indfb-draw-pwrite
[584.502131] Subtest fbchdr-1p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[584.595303] [134/156] (437s left) kms_frontbuffer_tracking (psrhdr-2p-scndscrn-spr-indfb-fullscreen)
[584.690433] Starting subtest: psrhdr-2p-scndscrn-spr-indfb-fullscreen
[584.695477] Subtest psrhdr-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s)
[584.809411] [135/156] (437s left) kms_pm_rpm (modeset-non-lpsp-stress)
[587.146166] Starting subtest: modeset-non-lpsp-stress
[588.300718] Subtest modeset-non-lpsp-stress: SKIP (1.159s)
[588.702243] [136/156] (433s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-pwrite)
[588.805612] Starting subtest: psr-2p-primscrn-spr-indfb-draw-pwrite
[588.810824] Subtest psr-2p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[588.885529] [137/156] (433s left) gem_partial_pwrite_pread (write)
[588.955919] Subtest write: SKIP (0.000s)
[589.029669] [138/156] (433s left) prime_vgem (basic-blt)
[589.102624] Starting subtest: basic-blt
[589.137438] Subtest basic-blt: SUCCESS (0.034s)
[589.255214] [139/156] (432s left) kms_frontbuffer_tracking (psrhdr-1p-primscrn-spr-indfb-fullscreen)
[589.354520] Starting subtest: psrhdr-1p-primscrn-spr-indfb-fullscreen
[589.359522] Subtest psrhdr-1p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[589.443385] [140/156] (432s left) kms_frontbuffer_tracking (fbchdr-1p-offscreen-pri-shrfb-draw-mmap-cpu)
[589.542548] Starting subtest: fbchdr-1p-offscreen-pri-shrfb-draw-mmap-cpu
[589.547243] Subtest fbchdr-1p-offscreen-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[589.647365] [141/156] (432s left) gem_userptr_blits (map-fixed-invalidate-busy)
[589.712543] Starting subtest: map-fixed-invalidate-busy
[589.716451] Subtest map-fixed-invalidate-busy: SKIP (0.000s)
[589.820494] [142/156] (432s left) i915_pm_rpm (system-suspend-execbuf)
[592.144240] Starting subtest: system-suspend-execbuf
[649.988114] Subtest system-suspend-execbuf: SUCCESS (42.148s)
[650.373389] [143/156] (371s left) kms_plane_lowres (tiling-none)
[650.460070] Starting subtest: tiling-none
[650.462336] Starting dynamic subtest: pipe-A-eDP-1
[650.466869] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[650.758658] Starting dynamic subtest: pipe-B-eDP-1
[650.763190] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[650.773728] Starting dynamic subtest: pipe-C-eDP-1
[650.778213] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[650.788203] Starting dynamic subtest: pipe-D-eDP-1
[650.792660] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[650.797059] Subtest tiling-none: SKIP (0.294s)
[651.599818] [144/156] (370s left) kms_frontbuffer_tracking (psrhdr-2p-primscrn-spr-indfb-onoff)
[651.703230] Starting subtest: psrhdr-2p-primscrn-spr-indfb-onoff
[651.707754] Subtest psrhdr-2p-primscrn-spr-indfb-onoff: SKIP (0.000s)
[651.812192] [145/156] (370s left) kms_frontbuffer_tracking (psrhdr-2p-primscrn-pri-indfb-draw-mmap-gtt)
[651.923486] Starting subtest: psrhdr-2p-primscrn-pri-indfb-draw-mmap-gtt
[651.927596] Subtest psrhdr-2p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[652.020097] [146/156] (370s left) kms_cursor_legacy (short-flip-before-cursor-toggle)
[652.142731] Starting subtest: short-flip-before-cursor-toggle
[653.059609] Subtest short-flip-before-cursor-toggle: SUCCESS (0.917s)
[653.933017] [147/156] (368s left) kms_frontbuffer_tracking (fbchdr-2p-scndscrn-cur-indfb-draw-mmap-cpu)
[654.034864] Starting subtest: fbchdr-2p-scndscrn-cur-indfb-draw-mmap-cpu
[654.039149] Subtest fbchdr-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[654.134665] [148/156] (368s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-onoff)
[654.232334] Starting subtest: psr-1p-primscrn-spr-indfb-onoff
[661.268620] Subtest psr-1p-primscrn-spr-indfb-onoff: SUCCESS (7.043s)
[661.370755] [149/156] (361s left) syncobj_timeline (multi-wait-for-submit-available-submitted-signaled)
[661.422437] Starting subtest: multi-wait-for-submit-available-submitted-signaled
[661.424757] Subtest multi-wait-for-submit-available-submitted-signaled: SUCCESS (0.000s)
[661.543411] [150/156] (361s left) gem_exec_schedule (fairslice)
[661.605730] Starting subtest: fairslice
[661.608045] Starting dynamic subtest: rcs0
[663.618511] Dynamic subtest rcs0: SUCCESS (2.019s)
[663.630563] Starting dynamic subtest: bcs0
[665.637094] Dynamic subtest bcs0: SUCCESS (2.019s)
[665.647183] Starting dynamic subtest: vcs0
[667.657591] Dynamic subtest vcs0: SUCCESS (2.020s)
[667.667612] Starting dynamic subtest: vcs1
[669.679287] Dynamic subtest vcs1: SUCCESS (2.020s)
[669.689201] Starting dynamic subtest: vecs0
[671.698597] Dynamic subtest vecs0: SUCCESS (2.018s)
[671.711027] Starting dynamic subtest: ccs0
[673.717615] Dynamic subtest ccs0: SUCCESS (2.021s)
[673.719491] Subtest fairslice: SUCCESS (12.123s)
[674.017960] [151/156] (348s left) gem_wait (invalid-buf)
[674.079967] Starting subtest: invalid-buf
[674.082354] Subtest invalid-buf: SUCCESS (0.000s)
[674.301898] [152/156] (348s left) gem_pread (display)
[674.350231] Subtest display: SKIP (0.000s)
[674.404557] [153/156] (348s left) gem_exec_schedule (semaphore-noskip)
[674.479397] Starting subtest: semaphore-noskip
[674.963181] Subtest semaphore-noskip: SUCCESS (0.489s)
[675.315821] [154/156] (347s left) kms_big_fb (y-tiled-32bpp-rotate-180)
[675.412656] Starting subtest: y-tiled-32bpp-rotate-180
[675.416845] Subtest y-tiled-32bpp-rotate-180: SKIP (0.000s)
[675.504182] [155/156] (347s left) api_intel_allocator (two-level-inception-interruptible)
[675.568852] Starting subtest: two-level-inception-interruptible
[680.975991] Subtest two-level-inception-interruptible: SUCCESS (5.408s)
[681.108910] [156/156] (341s left) gem_exec_flush (basic-wb-pro-default)
[681.176770] Starting subtest: basic-wb-pro-default
[686.661400] Subtest basic-wb-pro-default: SUCCESS (5.487s)
[686.860133] Closing watchdogs
results: parsing output: 0/ for test: gem_ctx_persistence
results: parsing output: 1/ for test: kms_cursor_crc
results: parsing output: 2/ for test: perf
results: parsing output: 3/ for test: gem_mmap_gtt
results: parsing output: 4/ for test: kms_content_protection
results: parsing output: 5/ for test: sw_sync
results: parsing output: 6/ for test: kms_big_fb
results: parsing output: 7/ for test: gem_gtt_cpu_tlb
results: parsing output: 8/ for test: kms_vblank
results: parsing output: 9/ for test: kms_debugfs
results: parsing output: 10/ for test: gen7_exec_parse
results: parsing output: 11/ for test: gem_render_copy
results: parsing output: 12/ for test: kms_frontbuffer_tracking
results: parsing output: 13/ for test: syncobj_timeline
results: parsing output: 14/ for test: prime_vgem
results: parsing output: 15/ for test: kms_frontbuffer_tracking
results: parsing output: 16/ for test: sw_sync
results: parsing output: 17/ for test: kms_frontbuffer_tracking
results: parsing output: 18/ for test: gen3_mixed_blits
results: parsing output: 19/ for test: kms_frontbuffer_tracking
results: parsing output: 20/ for test: kms_atomic_transition
results: parsing output: 21/ for test: perf_pmu
results: parsing output: 22/ for test: kms_frontbuffer_tracking
results: parsing output: 23/ for test: kms_frontbuffer_tracking
results: parsing output: 24/ for test: gem_pxp
results: parsing output: 25/ for test: kms_color
results: parsing output: 26/ for test: kms_cursor_edge_walk
results: parsing output: 27/ for test: kms_frontbuffer_tracking
results: parsing output: 28/ for test: kms_rotation_crc
results: parsing output: 29/ for test: kms_big_fb
results: parsing output: 30/ for test: kms_frontbuffer_tracking
results: parsing output: 31/ for test: kms_frontbuffer_tracking
results: parsing output: 32/ for test: kms_ccs
results: parsing output: 33/ for test: fbdev
results: parsing output: 34/ for test: gem_eio
results: parsing output: 35/ for test: kms_psr
results: parsing output: 36/ for test: gem_mmap_offset
results: parsing output: 37/ for test: kms_psr2_sf
results: parsing output: 38/ for test: kms_frontbuffer_tracking
results: parsing output: 39/ for test: gem_ctx_create
results: parsing output: 40/ for test: gem_madvise
results: parsing output: 41/ for test: kms_psr
results: parsing output: 42/ for test: i915_drm_fdinfo
results: parsing output: 43/ for test: kms_ccs
results: parsing output: 44/ for test: kms_hdr
results: parsing output: 45/ for test: kms_pm_backlight
results: parsing output: 46/ for test: gem_render_copy
results: parsing output: 47/ for test: kms_invalid_mode
results: parsing output: 48/ for test: kms_frontbuffer_tracking
results: parsing output: 49/ for test: kms_frontbuffer_tracking
results: parsing output: 50/ for test: gem_exec_whisper
results: parsing output: 51/ for test: kms_frontbuffer_tracking
results: parsing output: 52/ for test: gem_spin_batch
results: parsing output: 53/ for test: gem_exec_fence
results: parsing output: 54/ for test: kms_frontbuffer_tracking
results: parsing output: 55/ for test: syncobj_timeline
results: parsing output: 56/ for test: kms_big_fb
results: parsing output: 57/ for test: gem_exec_async
results: parsing output: 58/ for test: kms_flip_scaled_crc
results: parsing output: 59/ for test: syncobj_timeline
results: parsing output: 60/ for test: kms_frontbuffer_tracking
results: parsing output: 61/ for test: kms_chamelium_hpd
results: parsing output: 62/ for test: kms_big_fb
results: parsing output: 63/ for test: gen7_exec_parse
results: parsing output: 64/ for test: gem_caching
results: parsing output: 65/ for test: kms_frontbuffer_tracking
results: parsing output: 66/ for test: i915_suspend
results: parsing output: 67/ for test: gem_create
results: parsing output: 68/ for test: kms_ccs
results: parsing output: 69/ for test: kms_frontbuffer_tracking
results: parsing output: 70/ for test: kms_frontbuffer_tracking
results: parsing output: 71/ for test: kms_frontbuffer_tracking
results: parsing output: 72/ for test: kms_cursor_legacy
results: parsing output: 73/ for test: prime_vgem
results: parsing output: 74/ for test: kms_draw_crc
results: parsing output: 75/ for test: kms_frontbuffer_tracking
results: parsing output: 76/ for test: kms_frontbuffer_tracking
results: parsing output: 77/ for test: gem_exec_balancer
results: parsing output: 78/ for test: kms_frontbuffer_tracking
results: parsing output: 79/ for test: kms_flip_scaled_crc
results: parsing output: 80/ for test: gem_ctx_isolation
results: parsing output: 81/ for test: kms_frontbuffer_tracking
results: parsing output: 82/ for test: kms_cursor_crc
results: parsing output: 83/ for test: core_getclient
results: parsing output: 84/ for test: kms_addfb_basic
results: parsing output: 85/ for test: kms_frontbuffer_tracking
results: parsing output: 86/ for test: kms_busy
results: parsing output: 87/ for test: syncobj_basic
results: parsing output: 88/ for test: syncobj_timeline
results: parsing output: 89/ for test: gem_exec_schedule
results: parsing output: 90/ for test: gem_lmem_swapping
results: parsing output: 91/ for test: kms_plane
results: parsing output: 92/ for test: gem_userptr_blits
results: parsing output: 93/ for test: kms_chamelium_edid
results: parsing output: 94/ for test: kms_frontbuffer_tracking
results: parsing output: 95/ for test: sw_sync
results: parsing output: 96/ for test: i915_pm_freq_mult
results: parsing output: 97/ for test: sysfs_timeslice_duration
results: parsing output: 98/ for test: kms_rotation_crc
results: parsing output: 99/ for test: kms_pm_rpm
results: parsing output: 100/ for test: kms_lease
results: parsing output: 101/ for test: kms_psr2_sf
results: parsing output: 102/ for test: kms_ccs
results: parsing output: 103/ for test: gem_pxp
results: parsing output: 104/ for test: kms_frontbuffer_tracking
results: parsing output: 105/ for test: kms_psr
results: parsing output: 106/ for test: kms_frontbuffer_tracking
results: parsing output: 107/ for test: gem_madvise
results: parsing output: 108/ for test: kms_flip
results: parsing output: 109/ for test: gem_userptr_blits
results: parsing output: 110/ for test: kms_flip
results: parsing output: 111/ for test: kms_plane_multiple
results: parsing output: 112/ for test: drm_mm
results: parsing output: 113/ for test: kms_psr
results: parsing output: 114/ for test: kms_addfb_basic
results: parsing output: 115/ for test: kms_frontbuffer_tracking
results: parsing output: 116/ for test: kms_flip
results: parsing output: 117/ for test: kms_frontbuffer_tracking
results: parsing output: 118/ for test: kms_big_fb
results: parsing output: 119/ for test: perf_pmu
results: parsing output: 120/ for test: kms_cursor_legacy
results: parsing output: 121/ for test: kms_frontbuffer_tracking
results: parsing output: 122/ for test: kms_frontbuffer_tracking
results: parsing output: 123/ for test: gem_exec_balancer
results: parsing output: 124/ for test: kms_frontbuffer_tracking
results: parsing output: 125/ for test: kms_plane
results: parsing output: 126/ for test: kms_psr2_su
results: parsing output: 127/ for test: kms_vrr
results: parsing output: 128/ for test: kms_cursor_legacy
results: parsing output: 129/ for test: kms_frontbuffer_tracking
results: parsing output: 130/ for test: kms_ccs
results: parsing output: 131/ for test: sw_sync
results: parsing output: 132/ for test: kms_frontbuffer_tracking
results: parsing output: 133/ for test: kms_frontbuffer_tracking
results: parsing output: 134/ for test: kms_pm_rpm
results: parsing output: 135/ for test: kms_frontbuffer_tracking
results: parsing output: 136/ for test: gem_partial_pwrite_pread
results: parsing output: 137/ for test: prime_vgem
results: parsing output: 138/ for test: kms_frontbuffer_tracking
results: parsing output: 139/ for test: kms_frontbuffer_tracking
results: parsing output: 140/ for test: gem_userptr_blits
results: parsing output: 141/ for test: i915_pm_rpm
results: parsing output: 142/ for test: kms_plane_lowres
results: parsing output: 143/ for test: kms_frontbuffer_tracking
results: parsing output: 144/ for test: kms_frontbuffer_tracking
results: parsing output: 145/ for test: kms_cursor_legacy
results: parsing output: 146/ for test: kms_frontbuffer_tracking
results: parsing output: 147/ for test: kms_frontbuffer_tracking
results: parsing output: 148/ for test: syncobj_timeline
results: parsing output: 149/ for test: gem_exec_schedule
results: parsing output: 150/ for test: gem_wait
results: parsing output: 151/ for test: gem_pread
results: parsing output: 152/ for test: gem_exec_schedule
results: parsing output: 153/ for test: kms_big_fb
results: parsing output: 154/ for test: api_intel_allocator
results: parsing output: 155/ for test: gem_exec_flush
Done.