[55.828183] Initializing watchdogs
[55.828260]   /dev/watchdog0
[55.844036] [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.848664] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[55.851420] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[55.854963] [001/156] (960s left) gem_ctx_persistence (userptr)
[55.942873] Starting subtest: userptr
[56.125322] Subtest userptr: SUCCESS (0.183s)
[56.215639] [002/156] (960s left) kms_cursor_crc (cursor-offscreen-512x170)
[56.529071] Starting subtest: cursor-offscreen-512x170
[56.533349] Subtest cursor-offscreen-512x170: SKIP (0.001s)
[56.695967] [003/156] (959s left) perf (oa-formats)
[56.821330] Starting subtest: oa-formats
[56.823155] Starting dynamic subtest: 0-rcs0
[56.836348] Dynamic subtest 0-rcs0: SUCCESS (0.015s)
[56.843797] Starting dynamic subtest: 1-vcs0
[56.858410] Dynamic subtest 1-vcs0: SUCCESS (0.022s)
[56.860453] Subtest oa-formats: SUCCESS (0.037s)
[56.905567] [004/156] (959s left) gem_mmap_gtt (cpuset-big-copy-odd)
[56.955600] Subtest cpuset-big-copy-odd: SKIP (0.000s)
[57.016793] [005/156] (959s left) kms_content_protection (uevent-hdcp14)
[57.150082] Starting subtest: uevent-hdcp14
[57.154100] Subtest uevent-hdcp14: SKIP (0.000s)
[57.275462] [006/156] (959s left) sw_sync (sync_random_merge)
[57.307982] Starting subtest: sync_random_merge
[57.354712] Subtest sync_random_merge: SUCCESS (0.048s)
[57.428687] [007/156] (959s left) kms_big_fb (linear-16bpp-rotate-0)
[57.526933] Starting subtest: linear-16bpp-rotate-0
[58.928598] Subtest linear-16bpp-rotate-0: SUCCESS (1.401s)
[59.044765] [008/156] (957s left) gem_gtt_cpu_tlb
[59.145928] [009/156] (957s left) kms_vblank (query-forked-busy)
[59.251959] Starting subtest: query-forked-busy
[59.253583] Starting dynamic subtest: pipe-A-eDP-1
[61.134615] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.882s)
[61.149516] Starting dynamic subtest: pipe-D-eDP-1
[63.705455] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.568s)
[63.707817] Subtest query-forked-busy: SUCCESS (4.453s)
[64.513213] [010/156] (952s left) kms_debugfs (display-off-read-all)
[64.620229] Starting subtest: display-off-read-all
[64.912971] Subtest display-off-read-all: SUCCESS (0.295s)
[65.769642] [011/156] (950s left) gen7_exec_parse (basic-offset)
[65.823673] Subtest basic-offset: SKIP (0.000s)
[65.900709] [012/156] (950s left) gem_render_copy (x-tiled)
[65.952032] Starting subtest: x-tiled
[65.954351] Starting dynamic subtest: smem
[65.995966] Dynamic subtest smem: SUCCESS (0.044s)
[65.998498] Subtest x-tiled: SUCCESS (0.044s)
[66.189792] [013/156] (950s left) kms_frontbuffer_tracking (hdr-1p-primscrn-cur-indfb-draw-mmap-wc)
[66.285634] Starting subtest: hdr-1p-primscrn-cur-indfb-draw-mmap-wc
[66.289770] Subtest hdr-1p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[66.381433] [014/156] (950s left) syncobj_timeline (wait-all-interrupted)
[66.426898] Starting subtest: wait-all-interrupted
[66.532392] Subtest wait-all-interrupted: SUCCESS (0.105s)
[66.615899] [015/156] (950s left) prime_vgem (basic-fence-mmap)
[66.735358] Starting subtest: basic-fence-mmap
[66.740232] Subtest basic-fence-mmap: SKIP (0.000s)
[66.836438] [FACT prime_vgem (basic-fence-mmap)] new: kernel.kmod_is_loaded.vgem: true
[66.839561] [016/156] (950s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-scndscrn-pri-shrfb-draw-mmap-gtt)
[66.931939] Starting subtest: fbcpsrhdr-2p-scndscrn-pri-shrfb-draw-mmap-gtt
[66.936262] Subtest fbcpsrhdr-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[67.026489] [017/156] (949s left) sw_sync (sync_expired_merge)
[67.061808] Starting subtest: sync_expired_merge
[68.136330] Subtest sync_expired_merge: SUCCESS (1.074s)
[68.208187] [018/156] (948s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-render)
[68.316313] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-render
[72.064316] Subtest fbc-1p-primscrn-spr-indfb-draw-render: SUCCESS (3.764s)
[73.267339] [019/156] (943s left) gen3_mixed_blits
[73.474251] [020/156] (943s left) kms_frontbuffer_tracking (fbchdr-2p-pri-indfb-multidraw)
[73.634674] Starting subtest: fbchdr-2p-pri-indfb-multidraw
[73.639191] Subtest fbchdr-2p-pri-indfb-multidraw: SKIP (0.000s)
[73.734957] [021/156] (943s left) kms_atomic_transition (modeset-transition)
[73.827987] Starting subtest: modeset-transition
[73.830493] Starting dynamic subtest: 1x-outputs
[84.986020] Dynamic subtest 1x-outputs: SUCCESS (11.160s)
[84.988162] Subtest modeset-transition: SUCCESS (11.161s)
[85.859802] [022/156] (931s left) perf_pmu (init-wait)
[85.903824] Starting subtest: init-wait
[85.906115] Starting dynamic subtest: rcs0
[85.908407] Dynamic subtest rcs0: SUCCESS (0.002s)
[85.917902] Starting dynamic subtest: bcs0
[85.919767] Dynamic subtest bcs0: SUCCESS (0.000s)
[85.927587] Starting dynamic subtest: vcs0
[85.929479] Dynamic subtest vcs0: SUCCESS (0.000s)
[85.937282] Starting dynamic subtest: vcs1
[85.939147] Dynamic subtest vcs1: SUCCESS (0.001s)
[85.946772] Starting dynamic subtest: vecs0
[85.948630] Dynamic subtest vecs0: SUCCESS (0.001s)
[85.957349] Starting dynamic subtest: ccs0
[85.959478] Dynamic subtest ccs0: SUCCESS (0.000s)
[85.961612] Subtest init-wait: SUCCESS (0.006s)
[86.013758] [023/156] (931s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-blt)
[86.116577] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-blt
[86.121070] Subtest fbc-2p-primscrn-spr-indfb-draw-blt: SKIP (0.000s)
[86.214159] [024/156] (931s left) kms_frontbuffer_tracking (hdr-2p-scndscrn-spr-indfb-fullscreen)
[86.315817] Starting subtest: hdr-2p-scndscrn-spr-indfb-fullscreen
[86.320198] Subtest hdr-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s)
[86.401532] [025/156] (930s left) gem_pxp (protected-raw-src-copy-not-readible)
[86.525765] Starting subtest: protected-raw-src-copy-not-readible
[86.584034] Subtest protected-raw-src-copy-not-readible: SUCCESS (0.060s)
[86.713216] [026/156] (930s left) kms_color (ctm-signed)
[86.804186] Starting subtest: ctm-signed
[86.806079] Starting dynamic subtest: pipe-A-eDP-1
[88.935204] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.131s)
[88.945235] Starting dynamic subtest: pipe-B-eDP-1
[91.806184] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.871s)
[91.815873] Starting dynamic subtest: pipe-C-eDP-1
[95.352806] Dynamic subtest pipe-C-eDP-1: SUCCESS (3.542s)
[95.363360] Starting dynamic subtest: pipe-D-eDP-1
[97.554908] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.203s)
[97.557957] Subtest ctm-signed: SUCCESS (10.750s)
[98.373104] [027/156] (919s left) kms_cursor_edge_walk (128x128-right-edge)
[98.483889] Starting subtest: 128x128-right-edge
[98.486050] Starting dynamic subtest: pipe-A-eDP-1
[101.946319] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.462s)
[101.956738] Starting dynamic subtest: pipe-D-eDP-1
[105.084729] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.138s)
[105.087105] Subtest 128x128-right-edge: SUCCESS (6.602s)
[105.910252] [028/156] (911s left) kms_frontbuffer_tracking (fbc-1p-shrfb-fliptrack-mmap-gtt)
[106.008612] Starting subtest: fbc-1p-shrfb-fliptrack-mmap-gtt
[106.013039] Subtest fbc-1p-shrfb-fliptrack-mmap-gtt: SKIP (0.000s)
[106.116856] [029/156] (911s left) kms_rotation_crc (primary-yf-tiled-reflect-x-270)
[106.207815] Starting subtest: primary-yf-tiled-reflect-x-270
[106.212209] Subtest primary-yf-tiled-reflect-x-270: SKIP (0.001s)
[106.282966] [030/156] (911s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180-async-flip)
[106.380421] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180-async-flip
[107.037743] Subtest x-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SUCCESS (0.659s)
[107.211959] [031/156] (910s left) kms_frontbuffer_tracking (hdr-2p-primscrn-pri-indfb-draw-mmap-gtt)
[107.309753] Starting subtest: hdr-2p-primscrn-pri-indfb-draw-mmap-gtt
[107.313889] Subtest hdr-2p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[107.401120] [032/156] (910s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-render)
[107.491478] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-render
[107.495684] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s)
[107.585057] [033/156] (910s left) kms_ccs (bad-rotation-90-4-tiled-dg2-rc-ccs)
[107.671907] Starting subtest: bad-rotation-90-4-tiled-dg2-rc-ccs
[107.674297] Starting dynamic subtest: pipe-A-eDP-1
[107.697366] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[107.708175] Starting dynamic subtest: pipe-B-eDP-1
[107.729723] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[107.737781] Starting dynamic subtest: pipe-C-eDP-1
[107.760058] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[107.769538] Starting dynamic subtest: pipe-D-eDP-1
[107.791303] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[107.795694] Subtest bad-rotation-90-4-tiled-dg2-rc-ccs: SKIP (0.003s)
[110.012818] [034/156] (907s left) fbdev (unaligned-write)
[110.061300] Starting subtest: unaligned-write
[110.163959] Subtest unaligned-write: SUCCESS (0.102s)
[110.225859] [035/156] (907s left) gem_eio (throttle)
[110.445646] Starting subtest: throttle
[110.766458] Subtest throttle: SUCCESS (0.321s)
[110.929295] [036/156] (906s left) kms_psr (pr-cursor-mmap-cpu)
[111.022521] Starting subtest: pr-cursor-mmap-cpu
[111.026688] Subtest pr-cursor-mmap-cpu: SKIP (0.000s)
[111.108211] [037/156] (906s left) gem_mmap_offset (close-race)
[111.165949] Starting subtest: close-race
[131.277605] Subtest close-race: SUCCESS (20.112s)
[131.416662] [038/156] (886s left) kms_psr2_sf (fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf)
[131.521120] Starting subtest: fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf
[131.523437] Starting dynamic subtest: pipe-A-eDP-1
[131.619611] Dynamic subtest pipe-A-eDP-1: SKIP (0.100s)
[131.631982] Starting dynamic subtest: pipe-B-eDP-1
[132.749578] Dynamic subtest pipe-B-eDP-1: SKIP (1.128s)
[132.754335] Subtest fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf: SKIP (1.231s)
[133.976548] [039/156] (883s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-onoff)
[134.076626] Starting subtest: fbc-1p-primscrn-spr-indfb-onoff
[137.998630] Subtest fbc-1p-primscrn-spr-indfb-onoff: SUCCESS (3.927s)
[139.166115] [040/156] (878s left) gem_ctx_create (basic)
[139.235699] Starting subtest: basic
[139.238061] Subtest basic: SUCCESS (0.000s)
[139.423330] [041/156] (878s left) gem_madvise (dontneed-before-pwrite)
[139.457643] Starting subtest: dontneed-before-pwrite
[139.484446] Subtest dontneed-before-pwrite: SKIP (0.026s)
[139.546357] [042/156] (878s left) kms_psr (fbc-psr2-basic)
[139.643068] Starting subtest: fbc-psr2-basic
[139.645284] Starting dynamic subtest: eDP-1
[139.649257] Dynamic subtest eDP-1: SKIP (0.000s)
[139.653264] Subtest fbc-psr2-basic: SKIP (0.001s)
[139.716956] [043/156] (878s left) i915_drm_fdinfo (all-busy-check-all)
[139.755550] Starting subtest: all-busy-check-all
[139.762532] Subtest all-busy-check-all: SKIP (0.004s)
[139.841824] [044/156] (878s left) kms_ccs (random-ccs-data-y-tiled-gen12-mc-ccs)
[139.955361] Starting subtest: random-ccs-data-y-tiled-gen12-mc-ccs
[139.957696] Starting dynamic subtest: pipe-A-eDP-1
[139.983697] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[139.993763] Starting dynamic subtest: pipe-B-eDP-1
[140.017975] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[140.026955] Starting dynamic subtest: pipe-C-eDP-1
[140.051798] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[140.060873] Starting dynamic subtest: pipe-D-eDP-1
[140.084923] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[140.089700] Subtest random-ccs-data-y-tiled-gen12-mc-ccs: SKIP (0.003s)
[142.219768] [045/156] (875s left) kms_hdr (invalid-hdr)
[142.311015] Starting subtest: invalid-hdr
[142.313380] Starting dynamic subtest: pipe-A-eDP-1-XRGB2101010
[147.530253] Dynamic subtest pipe-A-eDP-1-XRGB2101010: SUCCESS (5.216s)
[147.548069] Starting dynamic subtest: pipe-A-eDP-1-XRGB16161616F
[151.651061] Dynamic subtest pipe-A-eDP-1-XRGB16161616F: SUCCESS (4.105s)
[151.661415] Subtest invalid-hdr: SUCCESS (9.353s)
[151.788324] [046/156] (866s left) kms_pm_backlight (fade-with-suspend)
[151.884059] Starting subtest: fade-with-suspend
[169.389041] Starting dynamic subtest: eDP-1
[172.400608] Dynamic subtest eDP-1: SUCCESS (3.016s)
[172.403014] Subtest fade-with-suspend: SUCCESS (6.603s)
[176.295334] [047/156] (845s left) gem_render_copy (y-tiled-mc-ccs-to-vebox-y-tiled)
[176.366070] Starting subtest: y-tiled-mc-ccs-to-vebox-y-tiled
[176.370614] Subtest y-tiled-mc-ccs-to-vebox-y-tiled: SKIP (0.000s)
[176.563758] [048/156] (844s left) kms_invalid_mode (bad-htotal)
[176.662187] Starting subtest: bad-htotal
[176.664496] Starting dynamic subtest: pipe-A-eDP-1
[176.951645] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.288s)
[176.962015] Starting dynamic subtest: pipe-B-eDP-1
[176.963927] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[176.973973] Starting dynamic subtest: pipe-C-eDP-1
[176.976172] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[176.985780] Starting dynamic subtest: pipe-D-eDP-1
[176.988035] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[176.990338] Subtest bad-htotal: SUCCESS (0.293s)
[177.823560] [049/156] (843s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-draw-mmap-wc)
[177.924009] Starting subtest: fbc-1p-primscrn-cur-indfb-draw-mmap-wc
[181.546949] Subtest fbc-1p-primscrn-cur-indfb-draw-mmap-wc: SUCCESS (3.628s)
[182.754362] [050/156] (838s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-pwrite)
[182.854270] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-pwrite
[182.858742] Subtest psr-2p-scndscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[182.953374] [051/156] (838s left) gem_exec_whisper (basic-fds-forked-all)
[183.011001] Starting subtest: basic-fds-forked-all
[202.674344] Subtest basic-fds-forked-all: SUCCESS (19.660s)
[202.860449] [052/156] (818s left) kms_frontbuffer_tracking (hdr-2p-scndscrn-cur-indfb-draw-mmap-cpu)
[202.962025] Starting subtest: hdr-2p-scndscrn-cur-indfb-draw-mmap-cpu
[202.966497] Subtest hdr-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[203.050267] [053/156] (818s left) gem_spin_batch (resubmit)
[203.106983] Starting subtest: resubmit
[203.109345] Starting dynamic subtest: rcs0
[203.114052] Dynamic subtest rcs0: SUCCESS (0.006s)
[203.125760] Starting dynamic subtest: bcs0
[203.127897] Dynamic subtest bcs0: SUCCESS (0.002s)
[203.138866] Starting dynamic subtest: vcs0
[203.141179] Dynamic subtest vcs0: SUCCESS (0.002s)
[203.151575] Starting dynamic subtest: vcs1
[203.153714] Dynamic subtest vcs1: SUCCESS (0.003s)
[203.163967] Starting dynamic subtest: vecs0
[203.166048] Dynamic subtest vecs0: SUCCESS (0.003s)
[203.176152] Starting dynamic subtest: ccs0
[203.178239] Dynamic subtest ccs0: SUCCESS (0.002s)
[203.180323] Subtest resubmit: SUCCESS (0.021s)
[203.367329] [054/156] (818s left) gem_exec_fence (syncobj-channel)
[203.898279] Starting subtest: syncobj-channel
[204.919232] Subtest syncobj-channel: SUCCESS (1.018s)
[205.318936] [055/156] (816s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-primscrn-spr-indfb-draw-blt)
[205.412982] Starting subtest: fbcpsrhdr-2p-primscrn-spr-indfb-draw-blt
[205.417057] Subtest fbcpsrhdr-2p-primscrn-spr-indfb-draw-blt: SKIP (0.000s)
[205.518977] [056/156] (816s left) syncobj_timeline (etime-multi-wait-all-submitted)
[205.572972] Starting subtest: etime-multi-wait-all-submitted
[205.676363] Subtest etime-multi-wait-all-submitted: SUCCESS (0.103s)
[205.756627] [057/156] (815s left) kms_big_fb (yf-tiled-8bpp-rotate-180)
[205.850269] Starting subtest: yf-tiled-8bpp-rotate-180
[205.854621] Subtest yf-tiled-8bpp-rotate-180: SKIP (0.000s)
[205.961670] [058/156] (815s left) gem_exec_async (forked-writes)
[206.016685] Starting subtest: forked-writes
[206.018976] Starting dynamic subtest: rcs0
[206.048204] Dynamic subtest rcs0: SUCCESS (0.031s)
[206.062070] Starting dynamic subtest: bcs0
[206.072003] Dynamic subtest bcs0: SUCCESS (0.023s)
[206.086521] Starting dynamic subtest: vcs0
[206.095346] Dynamic subtest vcs0: SUCCESS (0.023s)
[206.109437] Starting dynamic subtest: vcs1
[206.117734] Dynamic subtest vcs1: SUCCESS (0.022s)
[206.130665] Starting dynamic subtest: vecs0
[206.142122] Dynamic subtest vecs0: SUCCESS (0.024s)
[206.154470] Starting dynamic subtest: ccs0
[206.165433] Dynamic subtest ccs0: SUCCESS (0.023s)
[206.167696] Subtest forked-writes: SUCCESS (0.149s)
[206.388351] [059/156] (815s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-64bpp-yftile-downscaling)
[206.477400] Starting subtest: flip-32bpp-yftile-to-64bpp-yftile-downscaling
[206.481524] Subtest flip-32bpp-yftile-to-64bpp-yftile-downscaling: SKIP (0.000s)
[206.550722] [060/156] (815s left) syncobj_timeline (invalid-multi-wait-unsubmitted-submitted)
[206.614420] Starting subtest: invalid-multi-wait-unsubmitted-submitted
[206.616809] Subtest invalid-multi-wait-unsubmitted-submitted: SUCCESS (0.000s)
[206.706608] [061/156] (815s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-render)
[206.806191] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-render
[206.810572] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-render: SKIP (0.000s)
[206.902605] [062/156] (815s left) kms_chamelium_hpd (dp-hpd-storm)
[207.284692] Subtest dp-hpd-storm: SKIP (0.000s)
[208.162105] [063/156] (813s left) kms_big_fb (4-tiled-addfb)
[208.263301] Starting subtest: 4-tiled-addfb
[208.265612] Subtest 4-tiled-addfb: SUCCESS (0.000s)
[208.369958] [064/156] (813s left) gen7_exec_parse (oacontrol-tracking)
[208.425930] Subtest oacontrol-tracking: SKIP (0.000s)
[208.496084] [065/156] (813s left) gem_caching (reads)
[208.563978] Subtest reads: SKIP (0.000s)
[208.638154] [066/156] (813s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-plflip-blt)
[208.734052] Starting subtest: fbc-2p-primscrn-shrfb-plflip-blt
[208.738249] Subtest fbc-2p-primscrn-shrfb-plflip-blt: SKIP (0.000s)
[208.828529] [067/156] (813s left) i915_suspend (basic-s3-without-i915)
[208.865495] Starting subtest: basic-s3-without-i915
[210.711981] Subtest basic-s3-without-i915: SKIP (1.841s)
[212.339108] [068/156] (809s left) gem_create (create-ext-placement-sanity-check)
[212.524491] Starting subtest: create-ext-placement-sanity-check
[212.530965] Subtest create-ext-placement-sanity-check: SUCCESS (0.005s)
[212.624392] [069/156] (809s left) kms_ccs (crc-primary-suspend-y-tiled-gen12-rc-ccs-cc)
[212.717287] Starting subtest: crc-primary-suspend-y-tiled-gen12-rc-ccs-cc
[212.719649] Starting dynamic subtest: pipe-A-eDP-1
[212.728760] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[212.738938] Starting dynamic subtest: pipe-B-eDP-1
[212.748008] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[212.758624] Starting dynamic subtest: pipe-C-eDP-1
[212.767381] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[212.776398] Starting dynamic subtest: pipe-D-eDP-1
[212.784540] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[212.788613] Subtest crc-primary-suspend-y-tiled-gen12-rc-ccs-cc: SKIP (0.004s)
[214.997319] [070/156] (807s left) kms_frontbuffer_tracking (fbchdr-2p-scndscrn-pri-indfb-draw-render)
[215.113408] Starting subtest: fbchdr-2p-scndscrn-pri-indfb-draw-render
[215.117900] Subtest fbchdr-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s)
[215.209830] [071/156] (807s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-render)
[215.301286] Starting subtest: psr-1p-offscreen-pri-indfb-draw-render
[222.770108] Subtest psr-1p-offscreen-pri-indfb-draw-render: SUCCESS (7.472s)
[222.900590] [072/156] (799s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-move)
[222.997099] Starting subtest: psr-2p-scndscrn-spr-indfb-move
[223.001069] Subtest psr-2p-scndscrn-spr-indfb-move: SKIP (0.000s)
[223.105721] [073/156] (799s left) kms_cursor_legacy (2x-cursor-vs-flip-atomic)
[223.220878] Starting subtest: 2x-cursor-vs-flip-atomic
[223.225474] Subtest 2x-cursor-vs-flip-atomic: SKIP (0.001s)
[223.369413] [074/156] (799s left) prime_vgem (basic-read)
[223.453166] Starting subtest: basic-read
[223.461863] Subtest basic-read: SKIP (0.007s)
[223.576833] [075/156] (798s left) kms_draw_crc (draw-method-render)
[223.669494] Starting subtest: draw-method-render
[223.671707] Starting dynamic subtest: xrgb8888-untiled
[223.926512] Dynamic subtest xrgb8888-untiled: SUCCESS (0.259s)
[223.936474] Starting dynamic subtest: rgb565-untiled
[224.182048] Dynamic subtest rgb565-untiled: SUCCESS (0.255s)
[224.192466] Starting dynamic subtest: xrgb2101010-untiled
[224.426384] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.243s)
[224.436288] Starting dynamic subtest: xbgr16161616f-untiled
[224.681892] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.255s)
[224.691511] Starting dynamic subtest: xrgb8888-xtiled
[224.815492] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.133s)
[224.825679] Starting dynamic subtest: rgb565-xtiled
[224.948833] Dynamic subtest rgb565-xtiled: SUCCESS (0.133s)
[224.960999] Starting dynamic subtest: xrgb2101010-xtiled
[225.071234] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.120s)
[225.081939] Starting dynamic subtest: xbgr16161616f-xtiled
[225.204516] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.132s)
[225.214485] Starting dynamic subtest: xrgb8888-4tiled
[225.326425] Dynamic subtest xrgb8888-4tiled: SUCCESS (0.121s)
[225.336394] Starting dynamic subtest: rgb565-4tiled
[225.448797] Dynamic subtest rgb565-4tiled: SUCCESS (0.122s)
[225.458363] Starting dynamic subtest: xrgb2101010-4tiled
[225.571087] Dynamic subtest xrgb2101010-4tiled: SUCCESS (0.121s)
[225.580842] Starting dynamic subtest: xbgr16161616f-4tiled
[225.704866] Dynamic subtest xbgr16161616f-4tiled: SUCCESS (0.133s)
[225.706718] Subtest draw-method-render: SUCCESS (2.037s)
[225.866921] [076/156] (796s left) kms_frontbuffer_tracking (fbcpsr-tiling-y)
[225.972193] Starting subtest: fbcpsr-tiling-y
[225.975650] Subtest fbcpsr-tiling-y: SKIP (0.000s)
[226.069601] [077/156] (796s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-blt)
[226.169932] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-blt
[233.248851] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-blt: SUCCESS (7.080s)
[233.413420] [078/156] (789s left) gem_exec_balancer (nop)
[233.482091] Starting subtest: nop
[280.298316] Subtest nop: SUCCESS (46.815s)
[280.599333] [079/156] (742s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-blt)
[280.706678] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-blt
[280.710841] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-blt: SKIP (0.000s)
[280.805462] [080/156] (741s left) kms_flip_scaled_crc (flip-64bpp-yftile-to-32bpp-yftile-downscaling)
[280.902735] Starting subtest: flip-64bpp-yftile-to-32bpp-yftile-downscaling
[280.907183] Subtest flip-64bpp-yftile-to-32bpp-yftile-downscaling: SKIP (0.000s)
[280.974736] [081/156] (741s left) gem_ctx_isolation (dirty-switch)
[281.025999] Starting subtest: dirty-switch
[281.028374] Starting dynamic subtest: rcs0
[281.207951] Dynamic subtest rcs0: SUCCESS (0.182s)
[281.218430] Starting dynamic subtest: bcs0
[281.410966] Dynamic subtest bcs0: SUCCESS (0.202s)
[281.422057] Starting dynamic subtest: vcs0
[281.616317] Dynamic subtest vcs0: SUCCESS (0.204s)
[281.628790] Starting dynamic subtest: vcs1
[283.446527] Dynamic subtest vcs1: SUCCESS (1.829s)
[283.457177] Starting dynamic subtest: vecs0
[285.444400] Dynamic subtest vecs0: SUCCESS (1.996s)
[285.454713] Starting dynamic subtest: ccs0
[287.471320] Dynamic subtest ccs0: SUCCESS (2.026s)
[287.473759] Subtest dirty-switch: SUCCESS (6.446s)
[287.721545] [082/156] (735s left) kms_frontbuffer_tracking (psr-1p-primscrn-indfb-plflip-blt)
[287.818257] Starting subtest: psr-1p-primscrn-indfb-plflip-blt
[295.200241] Subtest psr-1p-primscrn-indfb-plflip-blt: SUCCESS (7.386s)
[295.339299] [083/156] (727s left) kms_cursor_crc (cursor-rapid-movement-max-size)
[295.645191] Starting subtest: cursor-rapid-movement-max-size
[295.652078] Subtest cursor-rapid-movement-max-size: SKIP (0.000s)
[295.772108] [084/156] (727s left) core_getclient (basic)
[295.823571] Starting subtest: basic
[295.825848] Subtest basic: SUCCESS (0.000s)
[295.916259] [085/156] (727s left) kms_addfb_basic (unused-modifier)
[295.971737] Starting subtest: unused-modifier
[295.973929] Subtest unused-modifier: SUCCESS (0.000s)
[296.116950] [086/156] (726s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-onoff)
[296.211527] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-onoff
[303.246244] Subtest fbcpsr-1p-primscrn-cur-indfb-onoff: SUCCESS (7.038s)
[303.395132] [087/156] (719s left) kms_busy (basic-hang)
[303.491294] Starting subtest: basic-hang
[303.493595] Starting dynamic subtest: flip-pipe-A
[304.057493] Dynamic subtest flip-pipe-A: SUCCESS (0.567s)
[304.068836] Starting dynamic subtest: modeset-pipe-A
[307.706769] Dynamic subtest modeset-pipe-A: SUCCESS (3.648s)
[307.719020] Starting dynamic subtest: flip-pipe-D
[308.911534] Dynamic subtest flip-pipe-D: SUCCESS (1.200s)
[308.922286] Starting dynamic subtest: modeset-pipe-D
[312.346755] Dynamic subtest modeset-pipe-D: SUCCESS (3.433s)
[312.349092] Subtest basic-hang: SUCCESS (8.854s)
[313.151260] [088/156] (709s left) syncobj_basic (bad-handle-to-fd)
[313.211928] Starting subtest: bad-handle-to-fd
[313.213909] Subtest bad-handle-to-fd: SUCCESS (0.000s)
[313.322949] [089/156] (709s left) syncobj_timeline (multi-wait-all-for-submit-available-signaled)
[313.375974] Starting subtest: multi-wait-all-for-submit-available-signaled
[313.378367] Subtest multi-wait-all-for-submit-available-signaled: SUCCESS (0.000s)
[313.463672] [090/156] (709s left) gem_exec_schedule (implicit-write-read)
[313.540164] Starting subtest: implicit-write-read
[313.542404] Starting dynamic subtest: rcs0
[313.641048] Dynamic subtest rcs0: SUCCESS (0.112s)
[313.657224] Starting dynamic subtest: vcs0
[313.724355] Dynamic subtest vcs0: SUCCESS (0.082s)
[313.736793] Starting dynamic subtest: vcs1
[313.802246] Dynamic subtest vcs1: SUCCESS (0.078s)
[313.815895] Starting dynamic subtest: vecs0
[313.879755] Dynamic subtest vecs0: SUCCESS (0.077s)
[313.893515] Starting dynamic subtest: ccs0
[313.968257] Dynamic subtest ccs0: SUCCESS (0.088s)
[313.971001] Subtest implicit-write-read: SUCCESS (0.440s)
[315.357860] [091/156] (707s left) gem_lmem_swapping (heavy-random)
[315.401590] Subtest heavy-random: SKIP (0.000s)
[315.450415] [092/156] (707s left) kms_plane (pixel-format-y-tiled-modifier-source-clamping)
[315.552562] Starting subtest: pixel-format-y-tiled-modifier-source-clamping
[315.556647] Subtest pixel-format-y-tiled-modifier-source-clamping: SKIP (0.000s)
[315.639908] [093/156] (707s left) gem_userptr_blits (sync-unmap)
[315.708454] Starting subtest: sync-unmap
[315.720110] Subtest sync-unmap: SUCCESS (0.014s)
[315.844368] [094/156] (707s left) kms_chamelium_edid (hdmi-mode-timings)
[316.238065] Subtest hdmi-mode-timings: SKIP (0.000s)
[317.066685] [095/156] (706s left) kms_frontbuffer_tracking (hdr-2p-primscrn-cur-indfb-move)
[317.168316] Starting subtest: hdr-2p-primscrn-cur-indfb-move
[317.172777] Subtest hdr-2p-primscrn-cur-indfb-move: SKIP (0.000s)
[317.275688] [096/156] (706s left) sw_sync (alloc_timeline)
[317.307837] Starting subtest: alloc_timeline
[317.310295] Subtest alloc_timeline: SUCCESS (0.000s)
[317.362252] [097/156] (706s left) i915_pm_freq_mult (media-freq)
[317.411089] Starting subtest: media-freq
[317.413520] Starting dynamic subtest: gt0
[317.418028] Dynamic subtest gt0: SKIP (0.000s)
[317.430226] Starting dynamic subtest: gt1
[317.434606] Dynamic subtest gt1: SKIP (0.000s)
[317.438921] Subtest media-freq: SKIP (0.002s)
[317.526429] [098/156] (706s left) sysfs_timeslice_duration (duration)
[317.582480] Starting subtest: duration
[317.584769] Starting dynamic subtest: vecs0
[332.182508] Dynamic subtest vecs0: SUCCESS (14.596s)
[332.196008] Starting dynamic subtest: ccs0
[345.327760] Dynamic subtest ccs0: SUCCESS (13.143s)
[345.340812] Starting dynamic subtest: vcs0
[360.152343] Dynamic subtest vcs0: SUCCESS (14.819s)
[360.165848] Starting dynamic subtest: bcs0
[373.295413] Dynamic subtest bcs0: SUCCESS (13.141s)
[373.309553] Starting dynamic subtest: rcs0
[386.441521] Dynamic subtest rcs0: SUCCESS (13.143s)
[386.454293] Starting dynamic subtest: vcs1
[400.149927] Dynamic subtest vcs1: SUCCESS (13.703s)
[400.153185] Subtest duration: SUCCESS (82.562s)
[400.243392] [099/156] (623s left) kms_rotation_crc (multiplane-rotation)
[400.341344] Starting subtest: multiplane-rotation
[417.777579] Subtest multiplane-rotation: SUCCESS (17.438s)
[417.907600] [100/156] (605s left) kms_pm_rpm (legacy-planes-dpms)
[419.436935] Starting subtest: legacy-planes-dpms
[419.438988] Starting dynamic subtest: plane-65
[427.747480] Dynamic subtest plane-65: SUCCESS (8.313s)
[427.761150] Starting dynamic subtest: plane-95
[436.387501] Dynamic subtest plane-95: SUCCESS (8.636s)
[436.400855] Starting dynamic subtest: plane-125
[444.805521] Dynamic subtest plane-125: SUCCESS (8.416s)
[444.822474] Starting dynamic subtest: plane-135
[453.336835] Dynamic subtest plane-135: SUCCESS (8.526s)
[453.339465] Subtest legacy-planes-dpms: SUCCESS (33.903s)
[453.729109] [101/156] (569s left) kms_lease (simple-lease)
[453.818459] Starting subtest: simple-lease
[453.820795] Starting dynamic subtest: pipe-A-eDP-1
[454.325129] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.505s)
[454.341158] Starting dynamic subtest: pipe-B-eDP-1
[455.756609] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.430s)
[455.767972] Starting dynamic subtest: pipe-C-eDP-1
[457.255031] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.494s)
[457.265431] Starting dynamic subtest: pipe-D-eDP-1
[458.664045] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.408s)
[458.666256] Subtest simple-lease: SUCCESS (4.845s)
[459.473386] [102/156] (564s left) kms_psr2_sf (pr-cursor-plane-move-continuous-sf)
[459.565498] Starting subtest: pr-cursor-plane-move-continuous-sf
[459.569924] Subtest pr-cursor-plane-move-continuous-sf: SKIP (0.000s)
[459.642127] [103/156] (564s left) kms_ccs (crc-sprite-planes-basic-4-tiled-mtl-rc-ccs)
[459.733408] Starting subtest: crc-sprite-planes-basic-4-tiled-mtl-rc-ccs
[459.735616] Starting dynamic subtest: pipe-A-eDP-1
[460.209603] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.448s)
[460.222689] Starting dynamic subtest: pipe-B-eDP-1
[461.713498] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.502s)
[461.726388] Starting dynamic subtest: pipe-C-eDP-1
[463.050293] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.338s)
[463.064403] Starting dynamic subtest: pipe-D-eDP-1
[464.394126] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.342s)
[464.396607] Subtest crc-sprite-planes-basic-4-tiled-mtl-rc-ccs: SUCCESS (4.634s)
[465.582751] [104/156] (558s left) gem_pxp (create-protected-buffer)
[465.710753] Starting subtest: create-protected-buffer
[465.713139] Subtest create-protected-buffer: SUCCESS (0.000s)
[465.819177] [105/156] (558s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-primscrn-indfb-pgflip-blt)
[465.921774] Starting subtest: fbcpsrhdr-1p-primscrn-indfb-pgflip-blt
[465.926038] Subtest fbcpsrhdr-1p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[466.012920] [106/156] (557s left) kms_psr (psr2-sprite-mmap-cpu)
[466.102651] Starting subtest: psr2-sprite-mmap-cpu
[466.104930] Starting dynamic subtest: eDP-1
[467.784691] Dynamic subtest eDP-1: SUCCESS (1.681s)
[467.786953] Subtest psr2-sprite-mmap-cpu: SUCCESS (1.682s)
[468.663049] [107/156] (555s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-blt)
[468.761367] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-blt
[473.281194] Subtest fbc-1p-primscrn-pri-shrfb-draw-blt: SUCCESS (4.526s)
[474.476622] [108/156] (549s left) gem_madvise (dontneed-before-mmap)
[474.513405] Starting subtest: dontneed-before-mmap
[474.538150] Subtest dontneed-before-mmap: SUCCESS (0.027s)
[474.634884] [109/156] (549s left) kms_flip (2x-flip-vs-panning-vs-hang)
[474.719638] Starting subtest: 2x-flip-vs-panning-vs-hang
[474.724137] Subtest 2x-flip-vs-panning-vs-hang: SKIP (0.002s)
[474.823729] [110/156] (549s left) gem_userptr_blits (map-fixed-invalidate-overlap)
[474.900260] Starting subtest: map-fixed-invalidate-overlap
[474.904772] Subtest map-fixed-invalidate-overlap: SKIP (0.000s)
[475.029590] [111/156] (549s left) kms_flip (blocking-wf_vblank)
[475.118801] Starting subtest: blocking-wf_vblank
[475.121213] Starting dynamic subtest: A-eDP1
[484.096347] Dynamic subtest A-eDP1: SUCCESS (8.976s)
[484.110038] Starting dynamic subtest: B-eDP1
[493.027801] Dynamic subtest B-eDP1: SUCCESS (8.929s)
[493.040057] Starting dynamic subtest: C-eDP1
[501.945487] Dynamic subtest C-eDP1: SUCCESS (8.914s)
[501.956818] Starting dynamic subtest: D-eDP1
[510.878073] Dynamic subtest D-eDP1: SUCCESS (8.930s)
[510.882907] Subtest blocking-wf_vblank: SUCCESS (35.761s)
[512.104875] [112/156] (512s left) kms_plane_multiple (tiling-y)
[512.194511] Starting subtest: tiling-y
[512.198893] Subtest tiling-y: SKIP (0.000s)
[512.268129] [113/156] (511s left) drm_mm (drm_mm)
[512.303723] Starting subtest: drm_mm
[512.345941] Starting dynamic subtest: drm_test_mm_init
[512.430510] Dynamic subtest drm_test_mm_init: SUCCESS (0.085s)
[512.442636] Starting dynamic subtest: drm_test_mm_debug
[512.521631] Dynamic subtest drm_test_mm_debug: SUCCESS (0.089s)
[512.533846] Starting dynamic subtest: drm_test_mm_align32
[512.618616] Dynamic subtest drm_test_mm_align32: SUCCESS (0.097s)
[512.630744] Starting dynamic subtest: drm_test_mm_align64
[512.699600] Dynamic subtest drm_test_mm_align64: SUCCESS (0.081s)
[512.711146] Starting dynamic subtest: drm_test_mm_lowest
[512.796545] Dynamic subtest drm_test_mm_lowest: SUCCESS (0.096s)
[512.808066] Starting dynamic subtest: drm_test_mm_highest
[512.891467] Dynamic subtest drm_test_mm_highest: SUCCESS (0.094s)
[512.893702] Subtest drm_mm: SUCCESS (0.585s)
[513.054162] [114/156] (511s left) kms_psr (pr-sprite-mmap-cpu)
[513.143805] Starting subtest: pr-sprite-mmap-cpu
[513.147196] Subtest pr-sprite-mmap-cpu: SKIP (0.000s)
[513.216103] [115/156] (511s left) kms_addfb_basic (legacy-format)
[513.265901] Starting subtest: legacy-format
[513.292523] Subtest legacy-format: SUCCESS (0.025s)
[513.443863] [116/156] (510s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-pgflip-blt)
[513.540034] Starting subtest: fbc-1p-primscrn-shrfb-pgflip-blt
[518.068345] Subtest fbc-1p-primscrn-shrfb-pgflip-blt: SUCCESS (4.532s)
[519.220937] [117/156] (505s left) kms_flip (2x-blocking-absolute-wf_vblank-interruptible)
[519.310752] Starting subtest: 2x-blocking-absolute-wf_vblank-interruptible
[519.321840] Subtest 2x-blocking-absolute-wf_vblank-interruptible: SKIP (0.011s)
[519.451871] [118/156] (504s left) kms_frontbuffer_tracking (fbcpsrhdr-1p-offscreen-pri-shrfb-draw-pwrite)
[519.557778] Starting subtest: fbcpsrhdr-1p-offscreen-pri-shrfb-draw-pwrite
[519.561575] Subtest fbcpsrhdr-1p-offscreen-pri-shrfb-draw-pwrite: SKIP (0.000s)
[519.640550] [119/156] (504s left) kms_big_fb (linear-max-hw-stride-64bpp-rotate-0-hflip)
[519.740024] Starting subtest: linear-max-hw-stride-64bpp-rotate-0-hflip
[519.744431] Subtest linear-max-hw-stride-64bpp-rotate-0-hflip: SKIP (0.000s)
[519.837897] [120/156] (504s left) perf_pmu (busy)
[519.880944] Starting subtest: busy
[519.883284] Starting dynamic subtest: rcs0
[520.477773] Dynamic subtest rcs0: SUCCESS (0.597s)
[520.491301] Starting dynamic subtest: bcs0
[521.044921] Dynamic subtest bcs0: SUCCESS (0.565s)
[521.058106] Starting dynamic subtest: vcs0
[522.232377] Dynamic subtest vcs0: SUCCESS (1.184s)
[522.245946] Starting dynamic subtest: vcs1
[524.215860] Dynamic subtest vcs1: SUCCESS (1.981s)
[524.227657] Starting dynamic subtest: vecs0
[526.264406] Dynamic subtest vecs0: SUCCESS (2.046s)
[526.277161] Starting dynamic subtest: ccs0
[526.828997] Dynamic subtest ccs0: SUCCESS (0.563s)
[526.831536] Subtest busy: SUCCESS (6.950s)
[526.938856] [121/156] (497s left) kms_cursor_legacy (long-nonblocking-modeset-vs-cursor-atomic)
[527.058843] Starting subtest: long-nonblocking-modeset-vs-cursor-atomic
[545.352036] Subtest long-nonblocking-modeset-vs-cursor-atomic: SUCCESS (18.291s)
[546.228928] [122/156] (478s left) kms_frontbuffer_tracking (fbcpsr-2p-rte)
[546.340282] Starting subtest: fbcpsr-2p-rte
[546.344389] Subtest fbcpsr-2p-rte: SKIP (0.000s)
[546.438275] [123/156] (478s left) kms_frontbuffer_tracking (fbcpsrhdr-2p-primscrn-cur-indfb-draw-blt)
[546.539247] Starting subtest: fbcpsrhdr-2p-primscrn-cur-indfb-draw-blt
[546.543652] Subtest fbcpsrhdr-2p-primscrn-cur-indfb-draw-blt: SKIP (0.000s)
[546.646875] [124/156] (478s left) gem_exec_balancer (parallel-keep-in-fence)
[546.905113] Starting subtest: parallel-keep-in-fence
[548.033217] Subtest parallel-keep-in-fence: SUCCESS (1.128s)
[548.145867] [125/156] (476s left) kms_frontbuffer_tracking (fbcpsrhdr-rgb565-draw-mmap-wc)
[548.246273] Starting subtest: fbcpsrhdr-rgb565-draw-mmap-wc
[548.250314] Subtest fbcpsrhdr-rgb565-draw-mmap-wc: SKIP (0.000s)
[548.346065] [126/156] (476s left) kms_plane (plane-panning-bottom-right-suspend)
[548.437103] Starting subtest: plane-panning-bottom-right-suspend
[548.439245] Starting dynamic subtest: pipe-A
[566.743677] Dynamic subtest pipe-A: SUCCESS (3.227s)
[566.756946] Starting dynamic subtest: pipe-B
[585.756650] Dynamic subtest pipe-B: SUCCESS (3.933s)
[585.758666] Subtest plane-panning-bottom-right-suspend: SUCCESS (7.163s)
[592.578714] [127/156] (438s left) kms_psr2_su (page_flip-nv12)
[592.642741] Subtest page_flip-NV12: SKIP (0.000s)
[592.703129] [128/156] (438s left) kms_vrr (flip-basic-fastset)
[592.791075] Starting subtest: flip-basic-fastset
[592.797827] Subtest flip-basic-fastset: SKIP (0.000s)
[592.865153] [129/156] (438s left) kms_cursor_legacy (2x-cursor-vs-flip-legacy)
[592.993915] Starting subtest: 2x-cursor-vs-flip-legacy
[592.998510] Subtest 2x-cursor-vs-flip-legacy: SKIP (0.001s)
[593.139414] [130/156] (437s left) kms_frontbuffer_tracking (psrhdr-1p-primscrn-cur-indfb-draw-blt)
[593.233417] Starting subtest: psrhdr-1p-primscrn-cur-indfb-draw-blt
[593.237428] Subtest psrhdr-1p-primscrn-cur-indfb-draw-blt: SKIP (0.000s)
[593.336287] [131/156] (437s left) kms_ccs (bad-rotation-90-y-tiled-gen12-mc-ccs)
[593.419958] Starting subtest: bad-rotation-90-y-tiled-gen12-mc-ccs
[593.422265] Starting dynamic subtest: pipe-A-eDP-1
[593.446617] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[593.460588] Starting dynamic subtest: pipe-B-eDP-1
[593.482242] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[593.492874] Starting dynamic subtest: pipe-C-eDP-1
[593.514622] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[593.528042] Starting dynamic subtest: pipe-D-eDP-1
[593.548732] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[593.552302] Subtest bad-rotation-90-y-tiled-gen12-mc-ccs: SKIP (0.005s)
[595.747481] [132/156] (435s left) sw_sync (sync_merge)
[595.782992] Starting subtest: sync_merge
[595.785270] Subtest sync_merge: SUCCESS (0.000s)
[595.843982] [133/156] (435s left) kms_frontbuffer_tracking (fbchdr-1p-primscrn-spr-indfb-draw-pwrite)
[595.948330] Starting subtest: fbchdr-1p-primscrn-spr-indfb-draw-pwrite
[595.952786] Subtest fbchdr-1p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[596.041139] [134/156] (435s left) kms_frontbuffer_tracking (psrhdr-2p-scndscrn-spr-indfb-fullscreen)
[596.139080] Starting subtest: psrhdr-2p-scndscrn-spr-indfb-fullscreen
[596.143203] Subtest psrhdr-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s)
[596.238289] [135/156] (434s left) kms_pm_rpm (modeset-non-lpsp-stress)
[598.564968] Starting subtest: modeset-non-lpsp-stress
[599.733894] Subtest modeset-non-lpsp-stress: SKIP (1.166s)
[600.132349] [136/156] (431s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-pwrite)
[600.231861] Starting subtest: psr-2p-primscrn-spr-indfb-draw-pwrite
[600.236016] Subtest psr-2p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[600.316129] [137/156] (430s left) gem_partial_pwrite_pread (write)
[600.367653] Subtest write: SKIP (0.000s)
[600.428946] [138/156] (430s left) prime_vgem (basic-blt)
[600.493660] Starting subtest: basic-blt
[600.521368] Subtest basic-blt: SUCCESS (0.028s)
[600.657189] [139/156] (430s left) kms_frontbuffer_tracking (psrhdr-1p-primscrn-spr-indfb-fullscreen)
[600.752951] Starting subtest: psrhdr-1p-primscrn-spr-indfb-fullscreen
[600.757971] Subtest psrhdr-1p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[600.849085] [140/156] (430s left) kms_frontbuffer_tracking (fbchdr-1p-offscreen-pri-shrfb-draw-mmap-cpu)
[600.946464] Starting subtest: fbchdr-1p-offscreen-pri-shrfb-draw-mmap-cpu
[600.950481] Subtest fbchdr-1p-offscreen-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[601.059220] [141/156] (430s left) gem_userptr_blits (map-fixed-invalidate-busy)
[601.116161] Starting subtest: map-fixed-invalidate-busy
[601.119971] Subtest map-fixed-invalidate-busy: SKIP (0.000s)
[601.240650] [142/156] (430s left) i915_pm_rpm (system-suspend-execbuf)
[603.561069] Starting subtest: system-suspend-execbuf
[664.878368] Subtest system-suspend-execbuf: SUCCESS (45.991s)
[665.283400] [143/156] (366s left) kms_plane_lowres (tiling-none)
[665.381577] Starting subtest: tiling-none
[665.383894] Starting dynamic subtest: pipe-A-eDP-1
[665.388556] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[665.680055] Starting dynamic subtest: pipe-B-eDP-1
[665.684626] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[665.694878] Starting dynamic subtest: pipe-C-eDP-1
[665.699453] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[665.709900] Starting dynamic subtest: pipe-D-eDP-1
[665.714056] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[665.718137] Subtest tiling-none: SKIP (0.296s)
[666.481753] [144/156] (365s left) kms_frontbuffer_tracking (psrhdr-2p-primscrn-spr-indfb-onoff)
[666.587956] Starting subtest: psrhdr-2p-primscrn-spr-indfb-onoff
[666.591953] Subtest psrhdr-2p-primscrn-spr-indfb-onoff: SKIP (0.000s)
[666.692010] [145/156] (364s left) kms_frontbuffer_tracking (psrhdr-2p-primscrn-pri-indfb-draw-mmap-gtt)
[666.807251] Starting subtest: psrhdr-2p-primscrn-pri-indfb-draw-mmap-gtt
[666.811746] Subtest psrhdr-2p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[666.907163] [146/156] (364s left) kms_cursor_legacy (short-flip-before-cursor-toggle)
[667.029217] Starting subtest: short-flip-before-cursor-toggle
[667.945097] Subtest short-flip-before-cursor-toggle: SUCCESS (0.916s)
[668.827461] [147/156] (362s left) kms_frontbuffer_tracking (fbchdr-2p-scndscrn-cur-indfb-draw-mmap-cpu)
[668.925178] Starting subtest: fbchdr-2p-scndscrn-cur-indfb-draw-mmap-cpu
[668.929628] Subtest fbchdr-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[669.021512] [148/156] (362s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-onoff)
[669.123877] Starting subtest: psr-1p-primscrn-spr-indfb-onoff
[676.174697] Subtest psr-1p-primscrn-spr-indfb-onoff: SUCCESS (7.056s)
[676.337058] [149/156] (355s left) syncobj_timeline (multi-wait-for-submit-available-submitted-signaled)
[676.383454] Starting subtest: multi-wait-for-submit-available-submitted-signaled
[676.385701] Subtest multi-wait-for-submit-available-submitted-signaled: SUCCESS (0.000s)
[676.472570] [150/156] (355s left) gem_exec_schedule (fairslice)
[676.534488] Starting subtest: fairslice
[676.536544] Starting dynamic subtest: rcs0
[678.549731] Dynamic subtest rcs0: SUCCESS (2.020s)
[678.562161] Starting dynamic subtest: bcs0
[680.573779] Dynamic subtest bcs0: SUCCESS (2.020s)
[680.586052] Starting dynamic subtest: vcs0
[682.592227] Dynamic subtest vcs0: SUCCESS (2.019s)
[682.602782] Starting dynamic subtest: vcs1
[684.612158] Dynamic subtest vcs1: SUCCESS (2.017s)
[684.624681] Starting dynamic subtest: vecs0
[686.631749] Dynamic subtest vecs0: SUCCESS (2.019s)
[686.643771] Starting dynamic subtest: ccs0
[688.650487] Dynamic subtest ccs0: SUCCESS (2.018s)
[688.652458] Subtest fairslice: SUCCESS (12.118s)
[688.950229] [151/156] (342s left) gem_wait (invalid-buf)
[689.007673] Starting subtest: invalid-buf
[689.009992] Subtest invalid-buf: SUCCESS (0.000s)
[689.239218] [152/156] (342s left) gem_pread (display)
[689.295995] Subtest display: SKIP (0.000s)
[689.355256] [153/156] (342s left) gem_exec_schedule (semaphore-noskip)
[689.425159] Starting subtest: semaphore-noskip
[689.897539] Subtest semaphore-noskip: SUCCESS (0.480s)
[690.245858] [154/156] (341s left) kms_big_fb (y-tiled-32bpp-rotate-180)
[690.346841] Starting subtest: y-tiled-32bpp-rotate-180
[690.351352] Subtest y-tiled-32bpp-rotate-180: SKIP (0.000s)
[690.439853] [155/156] (341s left) api_intel_allocator (two-level-inception-interruptible)
[690.496109] Starting subtest: two-level-inception-interruptible
[695.902909] Subtest two-level-inception-interruptible: SUCCESS (5.406s)
[696.028471] [156/156] (336s left) gem_exec_flush (basic-wb-pro-default)
[696.095284] Starting subtest: basic-wb-pro-default
[701.590833] Subtest basic-wb-pro-default: SUCCESS (5.494s)
[701.776791] 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.