[58.983747] Initializing watchdogs
[58.983898]   /dev/watchdog0
[58.999399] [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]
[59.003570] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[59.005787] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[59.009656] [001/133] (960s left) syncobj_timeline (single-wait-all-for-submit-signaled)
[59.093090] Starting subtest: single-wait-all-for-submit-signaled
[59.095512] Subtest single-wait-all-for-submit-signaled: SUCCESS (0.000s)
[59.197723] [002/133] (960s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-onoff)
[59.301560] Starting subtest: psr-2p-scndscrn-spr-indfb-onoff
[59.305983] Subtest psr-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s)
[59.401185] [003/133] (960s left) kms_joiner (invalid-modeset-force-ultra-joiner)
[59.507496] Starting subtest: invalid-modeset-force-ultra-joiner
[59.511671] Subtest invalid-modeset-force-ultra-joiner: SKIP (0.000s)
[59.567550] [004/133] (960s left) kms_plane_scaling (planes-downscale-factor-0-75-unity-scaling)
[59.659280] Starting subtest: planes-downscale-factor-0-75-unity-scaling
[59.661680] Starting dynamic subtest: pipe-A
[59.744582] Dynamic subtest pipe-A: SUCCESS (0.087s)
[59.754542] Starting dynamic subtest: pipe-B
[60.900292] Dynamic subtest pipe-B: SUCCESS (1.149s)
[60.909943] Starting dynamic subtest: pipe-C
[62.011432] Dynamic subtest pipe-C: SUCCESS (1.106s)
[62.019383] Starting dynamic subtest: pipe-D
[63.143950] Dynamic subtest pipe-D: SUCCESS (1.128s)
[63.146426] Subtest planes-downscale-factor-0-75-unity-scaling: SUCCESS (3.472s)
[64.308268] [005/133] (955s left) gem_exec_schedule (independent)
[64.389208] Starting subtest: independent
[64.391512] Starting dynamic subtest: rcs0
[65.943974] Dynamic subtest rcs0: SUCCESS (1.553s)
[65.964290] Starting dynamic subtest: vcs0
[68.034611] Dynamic subtest vcs0: SUCCESS (2.088s)
[68.045305] Starting dynamic subtest: vcs1
[69.917265] Dynamic subtest vcs1: SUCCESS (1.879s)
[69.927514] Starting dynamic subtest: vecs0
[71.898282] Dynamic subtest vecs0: SUCCESS (1.978s)
[71.905454] Starting dynamic subtest: ccs0
[73.877866] Dynamic subtest ccs0: SUCCESS (1.976s)
[73.880900] Subtest independent: SUCCESS (9.479s)
[74.191333] [006/133] (945s left) syncobj_timeline (reset-multiple-signaled)
[74.248096] Starting subtest: reset-multiple-signaled
[74.250495] Subtest reset-multiple-signaled: SUCCESS (0.000s)
[74.342854] [007/133] (945s left) gem_eio (in-flight-internal-10ms)
[74.578384] Starting subtest: in-flight-internal-10ms
[76.004893] Subtest in-flight-internal-10ms: SUCCESS (1.426s)
[76.134234] [008/133] (943s left) gem_mmap_gtt (basic-small-copy-xy)
[76.187060] Subtest basic-small-copy-XY: SKIP (0.000s)
[76.250333] [009/133] (943s left) kms_psr (fbc-psr2-primary-mmap-gtt)
[76.349527] Starting subtest: fbc-psr2-primary-mmap-gtt
[76.351593] Starting dynamic subtest: eDP-1
[76.355796] Dynamic subtest eDP-1: SKIP (0.000s)
[76.359978] Subtest fbc-psr2-primary-mmap-gtt: SKIP (0.000s)
[76.440557] [010/133] (943s left) kms_ccs (random-ccs-data-4-tiled-lnl-ccs)
[76.544827] Starting subtest: random-ccs-data-4-tiled-lnl-ccs
[76.549430] Subtest random-ccs-data-4-tiled-lnl-ccs: SKIP (0.000s)
[77.660117] [011/133] (942s left) i915_hangman (engine-engine-error)
[77.720083] Starting subtest: engine-engine-error
[77.722497] Starting dynamic subtest: rcs0
[78.898860] Dynamic subtest rcs0: SUCCESS (1.178s)
[78.907263] Starting dynamic subtest: bcs0
[80.819876] Dynamic subtest bcs0: SUCCESS (1.919s)
[80.831845] Starting dynamic subtest: vcs0
[81.906841] Dynamic subtest vcs0: SUCCESS (1.085s)
[81.918483] Starting dynamic subtest: vcs1
[83.891185] Dynamic subtest vcs1: SUCCESS (1.983s)
[83.902754] Starting dynamic subtest: vecs0
[85.875690] Dynamic subtest vecs0: SUCCESS (1.982s)
[85.886982] Starting dynamic subtest: ccs0
[87.860034] Dynamic subtest ccs0: SUCCESS (1.982s)
[87.862993] Subtest engine-engine-error: SUCCESS (10.136s)
[87.938885] [012/133] (931s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-blt)
[88.057189] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-blt
[92.534759] Subtest fbc-1p-primscrn-pri-shrfb-draw-blt: SUCCESS (4.484s)
[93.665574] [013/133] (926s left) gem_exec_params (sol-reset-not-gen7)
[93.727915] Starting subtest: sol-reset-not-gen7
[93.730463] Subtest sol-reset-not-gen7: SUCCESS (0.002s)
[93.850296] [014/133] (926s left) kms_plane_alpha_blend (constant-alpha-mid)
[93.939388] Starting subtest: constant-alpha-mid
[94.229782] Starting dynamic subtest: pipe-A-eDP-1
[95.078232] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.847s)
[95.092479] Starting dynamic subtest: pipe-D-eDP-1
[96.576984] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.498s)
[96.579744] Subtest constant-alpha-mid: SUCCESS (2.636s)
[97.404840] [015/133] (922s left) kms_content_protection (atomic-dpms-hdcp14)
[97.557263] Starting subtest: atomic-dpms-hdcp14
[97.562035] Subtest atomic-dpms-hdcp14: SKIP (0.000s)
[97.680744] [016/133] (922s left) gem_lmem_swapping (massive-random)
[97.726062] Subtest massive-random: SKIP (0.000s)
[97.770771] [017/133] (922s left) kms_pm_rpm (modeset-lpsp)
[100.121727] Starting subtest: modeset-lpsp
[101.594304] Subtest modeset-lpsp: SUCCESS (1.476s)
[101.696894] [018/133] (918s left) kms_color (deep-color)
[101.786440] Starting subtest: deep-color
[102.824070] Starting dynamic subtest: pipe-A-eDP-1-gamma
[103.516953] Dynamic subtest pipe-A-eDP-1-gamma: SUCCESS (0.691s)
[103.525498] Starting dynamic subtest: pipe-A-eDP-1-degamma
[104.931555] Dynamic subtest pipe-A-eDP-1-degamma: SUCCESS (1.414s)
[104.941018] Starting dynamic subtest: pipe-A-eDP-1-ctm
[106.320759] Dynamic subtest pipe-A-eDP-1-ctm: SUCCESS (1.389s)
[107.129678] Starting dynamic subtest: pipe-B-eDP-1-gamma
[107.833576] Dynamic subtest pipe-B-eDP-1-gamma: SUCCESS (0.710s)
[107.842776] Starting dynamic subtest: pipe-B-eDP-1-degamma
[109.302549] Dynamic subtest pipe-B-eDP-1-degamma: SUCCESS (1.468s)
[109.310687] Starting dynamic subtest: pipe-B-eDP-1-ctm
[110.727586] Dynamic subtest pipe-B-eDP-1-ctm: SUCCESS (1.426s)
[111.531986] Starting dynamic subtest: pipe-C-eDP-1-gamma
[112.173532] Dynamic subtest pipe-C-eDP-1-gamma: SUCCESS (0.649s)
[112.183384] Starting dynamic subtest: pipe-C-eDP-1-degamma
[113.567200] Dynamic subtest pipe-C-eDP-1-degamma: SUCCESS (1.392s)
[113.576073] Starting dynamic subtest: pipe-C-eDP-1-ctm
[114.910079] Dynamic subtest pipe-C-eDP-1-ctm: SUCCESS (1.343s)
[115.734580] Starting dynamic subtest: pipe-D-eDP-1-gamma
[116.404759] Dynamic subtest pipe-D-eDP-1-gamma: SUCCESS (0.674s)
[116.413789] Starting dynamic subtest: pipe-D-eDP-1-degamma
[117.774737] Dynamic subtest pipe-D-eDP-1-degamma: SUCCESS (1.370s)
[117.785563] Starting dynamic subtest: pipe-D-eDP-1-ctm
[119.222383] Dynamic subtest pipe-D-eDP-1-ctm: SUCCESS (1.448s)
[119.224405] Subtest deep-color: SUCCESS (17.432s)
[120.093601] [019/133] (900s left) kms_flip (2x-busy-flip)
[120.188627] Starting subtest: 2x-busy-flip
[120.196912] Subtest 2x-busy-flip: SKIP (0.010s)
[120.280317] [020/133] (899s left) kms_busy (basic)
[120.372823] Starting subtest: basic
[120.375221] Starting dynamic subtest: flip
[120.991045] Dynamic subtest flip: SUCCESS (0.615s)
[121.000239] Starting dynamic subtest: modeset
[124.410434] Dynamic subtest modeset: SUCCESS (3.419s)
[124.412774] Subtest basic: SUCCESS (4.036s)
[125.199139] [021/133] (895s left) kms_vblank (ts-continuation-idle)
[125.299298] Starting subtest: ts-continuation-idle
[125.301576] Starting dynamic subtest: pipe-A-eDP-1
[125.708081] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.408s)
[125.721682] Starting dynamic subtest: pipe-D-eDP-1
[126.799078] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.088s)
[126.801093] Subtest ts-continuation-idle: SUCCESS (1.499s)
[127.666971] [022/133] (892s left) kms_plane (pixel-format-linear-modifier-source-clamping)
[127.766133] Starting subtest: pixel-format-linear-modifier-source-clamping
[127.793781] Starting dynamic subtest: pipe-A-plane-0
[131.293524] Dynamic subtest pipe-A-plane-0: SUCCESS (3.500s)
[131.301845] Starting dynamic subtest: pipe-A-plane-3
[132.972072] Dynamic subtest pipe-A-plane-3: SUCCESS (1.676s)
[134.071789] Starting dynamic subtest: pipe-B-plane-0
[137.854681] Dynamic subtest pipe-B-plane-0: SUCCESS (3.789s)
[137.863523] Starting dynamic subtest: pipe-B-plane-3
[139.665072] Dynamic subtest pipe-B-plane-3: SUCCESS (1.810s)
[140.001319] Subtest pixel-format-linear-modifier-source-clamping: SUCCESS (12.232s)
[140.837184] [023/133] (879s left) kms_psr2_sf (psr2-primary-plane-update-sf-dmg-area-big-fb)
[140.945751] Starting subtest: psr2-primary-plane-update-sf-dmg-area-big-fb
[140.948119] Starting dynamic subtest: pipe-A-eDP-1
[147.540680] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.599s)
[147.554557] Starting dynamic subtest: pipe-B-eDP-1
[154.387864] Dynamic subtest pipe-B-eDP-1: SUCCESS (6.845s)
[154.390290] Subtest psr2-primary-plane-update-sf-dmg-area-big-fb: SUCCESS (13.447s)
[155.239329] [024/133] (865s left) gem_render_copy (x-tiled-to-vebox-yf-tiled)
[155.302228] Starting subtest: x-tiled-to-vebox-yf-tiled
[155.306853] Subtest x-tiled-to-vebox-yf-tiled: SKIP (0.000s)
[155.495922] [025/133] (864s left) kms_ccs (crc-primary-basic-4-tiled-dg2-rc-ccs-cc)
[155.581398] Starting subtest: crc-primary-basic-4-tiled-dg2-rc-ccs-cc
[155.583859] Starting dynamic subtest: pipe-A-eDP-1
[155.607374] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[155.617797] Starting dynamic subtest: pipe-B-eDP-1
[155.639259] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[155.647689] Starting dynamic subtest: pipe-C-eDP-1
[155.669182] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[155.679754] Starting dynamic subtest: pipe-D-eDP-1
[155.703137] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[155.707278] Subtest crc-primary-basic-4-tiled-dg2-rc-ccs-cc: SKIP (0.005s)
[157.815502] [026/133] (862s left) kms_psr (psr-cursor-mmap-gtt)
[157.905912] Starting subtest: psr-cursor-mmap-gtt
[157.908322] Starting dynamic subtest: eDP-1
[159.616379] Dynamic subtest eDP-1: SUCCESS (1.712s)
[159.618755] Subtest psr-cursor-mmap-gtt: SUCCESS (1.713s)
[160.491866] [027/133] (860s left) gen9_exec_parse (unaligned-access)
[160.561972] Subtest unaligned-access: SKIP (0.000s)
[160.646030] [028/133] (859s left) gem_tiled_pread_pwrite
[160.751092] [029/133] (859s left) gem_ctx_persistence (legacy-engines-mixed)
[160.801126] Starting subtest: legacy-engines-mixed
[160.803598] Starting dynamic subtest: render
[160.885232] Dynamic subtest render: SUCCESS (0.083s)
[160.896630] Starting dynamic subtest: bsd1
[160.936845] Dynamic subtest bsd1: SUCCESS (0.049s)
[160.947084] Starting dynamic subtest: bsd2
[160.990037] Dynamic subtest bsd2: SUCCESS (0.050s)
[160.999986] Starting dynamic subtest: blt
[161.040894] Dynamic subtest blt: SUCCESS (0.049s)
[161.054914] Starting dynamic subtest: vebox
[161.092630] Dynamic subtest vebox: SUCCESS (0.050s)
[161.095075] Subtest legacy-engines-mixed: SUCCESS (0.293s)
[161.168272] [030/133] (859s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180-async-flip)
[161.272896] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180-async-flip
[161.277302] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SKIP (0.000s)
[161.379063] [031/133] (859s left) api_intel_bb (destroy-bb)
[161.443408] Starting subtest: destroy-bb
[161.451209] Subtest destroy-bb: SUCCESS (0.008s)
[161.568822] [032/133] (859s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-64bpp-yftile-upscaling)
[161.672631] Starting subtest: flip-32bpp-yftile-to-64bpp-yftile-upscaling
[161.676542] Subtest flip-32bpp-yftile-to-64bpp-yftile-upscaling: SKIP (0.000s)
[161.741266] [033/133] (859s left) gem_exec_balancer (bonded-false-hang)
[162.012113] Starting subtest: bonded-false-hang
[162.016928] Subtest bonded-false-hang: SKIP (0.000s)
[162.115299] [034/133] (858s left) kms_atomic_interruptible (legacy-setmode)
[162.202476] Starting subtest: legacy-setmode
[162.204850] Starting dynamic subtest: pipe-A-eDP-1
[169.076547] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.873s)
[169.078926] Subtest legacy-setmode: SUCCESS (6.874s)
[169.875942] [035/133] (850s left) gem_userptr_blits (invalid-mmap-offset-unsync)
[169.938951] Subtest invalid-mmap-offset-unsync: SKIP (0.000s)
[170.063605] [036/133] (850s left) kms_cursor_legacy (2x-nonblocking-modeset-vs-cursor-atomic)
[170.205586] Starting subtest: 2x-nonblocking-modeset-vs-cursor-atomic
[170.209925] Subtest 2x-nonblocking-modeset-vs-cursor-atomic: SKIP (0.001s)
[170.369571] [037/133] (850s left) kms_cursor_edge_walk (128x128-right-edge)
[170.456281] Starting subtest: 128x128-right-edge
[170.458396] Starting dynamic subtest: pipe-A-eDP-1
[173.943601] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.486s)
[173.953083] Starting dynamic subtest: pipe-D-eDP-1
[177.069555] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.124s)
[177.071767] Subtest 128x128-right-edge: SUCCESS (6.613s)
[177.875889] [038/133] (843s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-mmap-cpu)
[177.981422] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-mmap-cpu
[184.507470] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-mmap-cpu: SUCCESS (6.529s)
[184.664339] [039/133] (836s left) gem_spin_batch (spin-all-new)
[184.725490] Starting subtest: spin-all-new
[184.745927] Subtest spin-all-new: SUCCESS (0.019s)
[185.940919] [040/133] (835s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-onoff)
[186.030656] Starting subtest: fbc-2p-primscrn-cur-indfb-onoff
[186.034702] Subtest fbc-2p-primscrn-cur-indfb-onoff: SKIP (0.000s)
[186.131731] [041/133] (834s left) kms_chamelium_hpd (dp-hpd-storm)
[186.522555] Subtest dp-hpd-storm: SKIP (0.000s)
[187.308204] [042/133] (833s left) kms_chamelium_color (gamma)
[187.397574] Subtest gamma: SKIP (0.000s)
[187.441634] [043/133] (833s left) kms_flip (modeset-vs-vblank-race)
[187.549598] Starting subtest: modeset-vs-vblank-race
[187.556061] Starting dynamic subtest: A-eDP1
[192.247779] Dynamic subtest A-eDP1: SUCCESS (4.693s)
[192.259732] Starting dynamic subtest: B-eDP1
[196.987612] Dynamic subtest B-eDP1: SUCCESS (4.737s)
[197.004254] Starting dynamic subtest: C-eDP1
[201.688318] Dynamic subtest C-eDP1: SUCCESS (4.698s)
[201.696461] Starting dynamic subtest: D-eDP1
[206.323155] Dynamic subtest D-eDP1: SUCCESS (4.633s)
[206.327902] Subtest modeset-vs-vblank-race: SUCCESS (18.779s)
[207.524106] [044/133] (813s left) kms_big_fb (4-tiled-32bpp-rotate-90)
[207.639766] Starting subtest: 4-tiled-32bpp-rotate-90
[207.659410] Subtest 4-tiled-32bpp-rotate-90: SKIP (0.019s)
[207.762654] [045/133] (813s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-mmap-cpu)
[207.846584] Starting subtest: psr-2p-primscrn-pri-indfb-draw-mmap-cpu
[207.850642] Subtest psr-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[207.944798] [046/133] (813s left) sriov_basic (enable-vfs-bind-unbind-each)
[207.996559] Starting subtest: enable-vfs-bind-unbind-each
[207.998805] Starting dynamic subtest: numvfs-1
[208.071422] Dynamic subtest numvfs-1: FAIL (0.016s)
[208.081146] Starting dynamic subtest: numvfs-2
[208.153731] Dynamic subtest numvfs-2: FAIL (0.004s)
[208.164475] Starting dynamic subtest: numvfs-3
[208.237724] Dynamic subtest numvfs-3: FAIL (0.004s)
[208.247299] Starting dynamic subtest: numvfs-4
[208.319805] Dynamic subtest numvfs-4: FAIL (0.004s)
[208.329657] Starting dynamic subtest: numvfs-5
[208.401510] Dynamic subtest numvfs-5: FAIL (0.004s)
[208.412741] Starting dynamic subtest: numvfs-6
[208.475892] Dynamic subtest numvfs-6: FAIL (0.004s)
[208.485128] Starting dynamic subtest: numvfs-7
[208.544302] Dynamic subtest numvfs-7: FAIL (0.003s)
[208.552792] Starting dynamic subtest: numvfs-random
[208.611323] Dynamic subtest numvfs-random: FAIL (0.004s)
[208.613261] Subtest enable-vfs-bind-unbind-each: FAIL (0.049s)
[208.649050] [047/133] (812s left) kms_plane_scaling (plane-scaler-unity-scaling-with-pixel-format)
[208.738552] Starting subtest: plane-scaler-unity-scaling-with-pixel-format
[208.740555] Starting dynamic subtest: pipe-A
[209.932580] Dynamic subtest pipe-A: SUCCESS (1.195s)
[209.941053] Starting dynamic subtest: pipe-B
[212.211490] Dynamic subtest pipe-B: SUCCESS (2.278s)
[212.221417] Starting dynamic subtest: pipe-C
[213.386111] Dynamic subtest pipe-C: SUCCESS (1.171s)
[213.394872] Starting dynamic subtest: pipe-D
[214.632531] Dynamic subtest pipe-D: SUCCESS (1.245s)
[214.635065] Subtest plane-scaler-unity-scaling-with-pixel-format: SUCCESS (5.898s)
[215.806932] [048/133] (805s left) kms_async_flips (test-time-stamp)
[215.903206] Starting subtest: test-time-stamp
[216.277937] Starting dynamic subtest: pipe-A-eDP-1
[217.113716] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.834s)
[217.493870] Starting dynamic subtest: pipe-B-eDP-1
[218.253777] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.764s)
[218.618216] Starting dynamic subtest: pipe-C-eDP-1
[219.380559] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.767s)
[219.741847] Starting dynamic subtest: pipe-D-eDP-1
[220.510811] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.774s)
[220.513322] Subtest test-time-stamp: SUCCESS (4.606s)
[221.671627] [049/133] (799s left) syncobj_eventfd (invalid-bad-pad)
[221.732850] Starting subtest: invalid-bad-pad
[221.735282] Subtest invalid-bad-pad: SUCCESS (0.000s)
[221.826460] [050/133] (799s left) kms_plane (pixel-format-4-tiled-dg2-rc-ccs-modifier)
[221.923429] Starting subtest: pixel-format-4-tiled-dg2-rc-ccs-modifier
[221.927867] Subtest pixel-format-4-tiled-dg2-rc-ccs-modifier: SKIP (0.000s)
[221.994131] [051/133] (799s left) kms_flip (flip-vs-blocking-wf-vblank)
[222.087822] Starting subtest: flip-vs-blocking-wf-vblank
[222.089826] Starting dynamic subtest: A-eDP1
[231.024986] Dynamic subtest A-eDP1: SUCCESS (8.939s)
[231.037337] Starting dynamic subtest: B-eDP1
[239.959933] Dynamic subtest B-eDP1: SUCCESS (8.933s)
[239.970439] Starting dynamic subtest: C-eDP1
[248.928933] Dynamic subtest C-eDP1: SUCCESS (8.922s)
[248.940120] Starting dynamic subtest: D-eDP1
[257.868404] Dynamic subtest D-eDP1: SUCCESS (8.933s)
[257.871133] Subtest flip-vs-blocking-wf-vblank: SUCCESS (35.739s)
[259.064146] [052/133] (762s left) gen9_exec_parse (batch-invalid-length)
[259.132218] Subtest batch-invalid-length: SKIP (0.000s)
[259.187452] [053/133] (762s left) kms_big_fb (y-tiled-16bpp-rotate-0)
[259.288500] Starting subtest: y-tiled-16bpp-rotate-0
[259.292577] Subtest y-tiled-16bpp-rotate-0: SKIP (0.000s)
[259.411459] [054/133] (762s left) kms_display_modes (extended-mode-basic)
[259.508068] Starting subtest: extended-mode-basic
[259.512420] Subtest extended-mode-basic: SKIP (0.000s)
[259.551883] [055/133] (762s left) gem_lmem_swapping (verify-random)
[259.596097] Subtest verify-random: SKIP (0.000s)
[259.639842] [056/133] (762s left) gem_ctx_param (basic-default)
[259.692982] Starting subtest: basic-default
[259.695395] Subtest basic-default: SUCCESS (0.000s)
[259.778973] [057/133] (761s left) gem_exec_gttfill (multigpu-basic)
[259.944891] Starting subtest: multigpu-basic
[273.127028] Subtest multigpu-basic: SUCCESS (13.187s)
[273.177499] [058/133] (748s left) kms_atomic_transition (plane-use-after-nonblocking-unbind)
[273.308170] Starting subtest: plane-use-after-nonblocking-unbind
[273.310526] Starting dynamic subtest: pipe-A-eDP-1
[273.368474] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.061s)
[273.663219] Starting dynamic subtest: pipe-B-eDP-1
[274.458668] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.805s)
[274.754806] Subtest plane-use-after-nonblocking-unbind: SUCCESS (1.448s)
[275.620120] [059/133] (746s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted-signaled)
[275.687114] Starting subtest: invalid-multi-wait-all-unsubmitted-signaled
[275.689510] Subtest invalid-multi-wait-all-unsubmitted-signaled: SUCCESS (0.000s)
[275.786187] [060/133] (746s left) gem_exec_reloc (basic-wc-cpu)
[275.847619] Subtest basic-wc-cpu: SKIP (0.000s)
[275.919689] [061/133] (745s left) gem_mmap (bad-object)
[275.975688] Subtest bad-object: SKIP (0.000s)
[276.027789] [062/133] (745s left) gem_userptr_blits (map-fixed-invalidate-overlap-busy)
[276.085346] Starting subtest: map-fixed-invalidate-overlap-busy
[276.089705] Subtest map-fixed-invalidate-overlap-busy: SKIP (0.000s)
[276.195173] [063/133] (745s left) i915_suspend (debugfs-reader)
[276.252917] Starting subtest: debugfs-reader
[294.266014] Subtest debugfs-reader: SUCCESS (3.243s)
[294.387597] [064/133] (727s left) gem_fenced_exec_thrash (2-spare-fences)
[294.459105] Subtest 2-spare-fences: SKIP (0.000s)
[294.534430] [065/133] (727s left) prime_mmap_coherency (read)
[294.585436] Starting subtest: read
[300.110489] Subtest read: SUCCESS (5.377s)
[300.177597] [066/133] (722s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[300.273579] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[300.277870] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[300.364575] [067/133] (721s left) kms_rotation_crc (primary-x-tiled-reflect-x-180)
[300.457202] Starting subtest: primary-x-tiled-reflect-x-180
[307.572620] Subtest primary-x-tiled-reflect-x-180: SUCCESS (7.064s)
[308.765455] [068/133] (713s left) gem_pxp (display-protected-crc)
[308.900681] Starting subtest: display-protected-crc
[310.558696] Subtest display-protected-crc: SUCCESS (1.655s)
[310.673714] [069/133] (711s left) syncobj_timeline (multi-wait-all-available-signaled)
[310.729708] Starting subtest: multi-wait-all-available-signaled
[310.732167] Subtest multi-wait-all-available-signaled: SUCCESS (0.000s)
[310.825320] [070/133] (711s left) gem_exec_whisper (basic-fds)
[310.901700] Starting subtest: basic-fds
[316.791853] Subtest basic-fds: SUCCESS (5.870s)
[316.982683] [071/133] (705s left) gem_exec_reloc (basic-cpu-wc)
[317.054418] Subtest basic-cpu-wc: SKIP (0.000s)
[317.125349] [072/133] (705s left) kms_frontbuffer_tracking (fbc-tiling-4)
[317.225346] Starting subtest: fbc-tiling-4
[321.464906] Subtest fbc-tiling-4: SUCCESS (4.237s)
[322.610066] [073/133] (699s left) gem_ctx_param (set-priority-invalid-size)
[322.673404] Starting subtest: set-priority-invalid-size
[322.675807] Subtest set-priority-invalid-size: SUCCESS (0.000s)
[322.747430] [074/133] (699s left) kms_flip (2x-absolute-wf_vblank-interruptible)
[322.850633] Starting subtest: 2x-absolute-wf_vblank-interruptible
[322.861432] Subtest 2x-absolute-wf_vblank-interruptible: SKIP (0.010s)
[322.936503] [075/133] (699s left) kms_cursor_crc (cursor-onscreen-64x21)
[323.127016] Starting subtest: cursor-onscreen-64x21
[323.171383] Subtest cursor-onscreen-64x21: SKIP (0.040s)
[323.411411] [076/133] (699s left) kms_selftest (drm_dp_mst_helper)
[323.460205] Starting subtest: drm_dp_mst_helper
[323.507368] Starting dynamic subtest: drm_test_dp_mst_calc_pbn_mode
[323.610553] Dynamic subtest drm_test_dp_mst_calc_pbn_mode: SUCCESS (0.107s)
[323.621062] Starting dynamic subtest: drm_test_dp_mst_calc_pbn_div
[323.723055] Dynamic subtest drm_test_dp_mst_calc_pbn_div: SUCCESS (0.111s)
[323.732180] Starting dynamic subtest: drm_test_dp_mst_sideband_msg_req_decode
[323.843174] Dynamic subtest drm_test_dp_mst_sideband_msg_req_decode: SUCCESS (0.119s)
[323.845084] Subtest drm_dp_mst_helper: SUCCESS (0.383s)
[323.987527] [077/133] (698s left) gem_exec_basic (basic)
[324.053893] Starting subtest: basic
[324.055798] Starting dynamic subtest: rcs0-smem
[324.057787] Dynamic subtest rcs0-smem: SUCCESS (0.004s)
[324.072529] Starting dynamic subtest: bcs0-smem
[324.074184] Dynamic subtest bcs0-smem: SUCCESS (0.002s)
[324.083347] Starting dynamic subtest: vcs0-smem
[324.084914] Dynamic subtest vcs0-smem: SUCCESS (0.002s)
[324.093355] Starting dynamic subtest: vcs1-smem
[324.094906] Dynamic subtest vcs1-smem: SUCCESS (0.001s)
[324.103816] Starting dynamic subtest: vecs0-smem
[324.105401] Dynamic subtest vecs0-smem: SUCCESS (0.002s)
[324.114168] Starting dynamic subtest: ccs0-smem
[324.115728] Dynamic subtest ccs0-smem: SUCCESS (0.002s)
[324.117545] Subtest basic: SUCCESS (0.016s)
[325.729495] [078/133] (696s left) gem_userptr_blits (stress-mm-invalidate-close)
[325.799030] Starting subtest: stress-mm-invalidate-close
[327.999190] Subtest stress-mm-invalidate-close: SUCCESS (2.148s)
[328.061469] [079/133] (694s left) i915_pm_rpm (gem-mmap-type)
[329.812905] Starting subtest: gem-mmap-type
[329.815678] Starting dynamic subtest: wb-smem0
[333.727834] Dynamic subtest wb-smem0: SUCCESS (3.916s)
[333.738179] Starting dynamic subtest: wc-smem0
[336.895640] Dynamic subtest wc-smem0: SUCCESS (3.167s)
[336.906415] Starting dynamic subtest: uc-smem0
[340.041507] Dynamic subtest uc-smem0: SUCCESS (3.143s)
[340.043851] Subtest gem-mmap-type: SUCCESS (10.229s)
[340.128480] [080/133] (682s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-pwrite)
[340.226264] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-pwrite
[340.230664] Subtest psr-2p-scndscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[340.327726] [081/133] (682s left) kms_ccs (bad-aux-stride-y-tiled-gen12-mc-ccs)
[340.435366] Starting subtest: bad-aux-stride-y-tiled-gen12-mc-ccs
[340.437695] Starting dynamic subtest: pipe-A-eDP-1
[340.460717] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[340.472631] Starting dynamic subtest: pipe-B-eDP-1
[340.494159] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[340.503296] Starting dynamic subtest: pipe-C-eDP-1
[340.525182] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[340.534282] Starting dynamic subtest: pipe-D-eDP-1
[340.556838] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[340.561293] Subtest bad-aux-stride-y-tiled-gen12-mc-ccs: SKIP (0.005s)
[342.669822] [082/133] (680s left) kms_cursor_legacy (long-nonblocking-modeset-vs-cursor-atomic)
[342.783549] Starting subtest: long-nonblocking-modeset-vs-cursor-atomic
[360.085426] Subtest long-nonblocking-modeset-vs-cursor-atomic: SUCCESS (17.294s)
[360.884750] [083/133] (661s left) kms_scaling_modes (scaling-mode-full)
[360.988363] Starting subtest: scaling-mode-full
[360.990668] Starting dynamic subtest: pipe-A-eDP-1
[361.085333] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.097s)
[361.096273] Starting dynamic subtest: pipe-B-eDP-1
[362.215239] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.128s)
[362.225528] Starting dynamic subtest: pipe-C-eDP-1
[363.327945] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.111s)
[363.342860] Starting dynamic subtest: pipe-D-eDP-1
[364.459940] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.128s)
[364.462385] Subtest scaling-mode-full: SUCCESS (3.472s)
[365.617297] [084/133] (657s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytileccs-downscaling)
[365.707305] Starting subtest: flip-32bpp-ytile-to-32bpp-ytileccs-downscaling
[365.711690] Subtest flip-32bpp-ytile-to-32bpp-ytileccs-downscaling: SKIP (0.000s)
[365.792587] [085/133] (657s left) kms_force_connector_basic (force-connector-state)
[365.868017] Starting subtest: force-connector-state
[366.475355] Subtest force-connector-state: SUCCESS (0.610s)
[367.461203] [086/133] (655s left) gem_userptr_blits (dmabuf-unsync)
[367.521520] Subtest dmabuf-unsync: SKIP (0.000s)
[367.635923] [087/133] (655s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-pwrite)
[367.726194] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-pwrite
[376.221003] Subtest psr-1p-primscrn-pri-shrfb-draw-pwrite: SUCCESS (8.495s)
[376.322915] [088/133] (646s left) gem_exec_alignment (single)
[376.383879] Starting subtest: single
[376.388871] Subtest single: SUCCESS (0.003s)
[376.532678] [089/133] (646s left) prime_mmap (test_map_unmap)
[376.585565] Starting subtest: test_map_unmap
[376.587740] Starting dynamic subtest: test_map_unmap-smem
[376.614162] Dynamic subtest test_map_unmap-smem: SUCCESS (0.031s)
[376.616587] Subtest test_map_unmap: SUCCESS (0.032s)
[376.726752] [090/133] (646s left) gem_exec_reloc (basic-gtt-wc-active)
[376.786497] Subtest basic-gtt-wc-active: SKIP (0.000s)
[376.864379] [091/133] (646s left) kms_addfb_basic (addfb25-x-tiled-legacy)
[376.965946] Subtest addfb25-x-tiled-legacy: SKIP (0.000s)
[377.063420] [092/133] (646s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip)
[377.158673] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip
[377.783600] Subtest x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SUCCESS (0.626s)
[377.953776] [093/133] (645s left) kms_psr (fbc-psr-dpms)
[378.042271] Starting subtest: fbc-psr-dpms
[378.044505] Starting dynamic subtest: eDP-1
[378.048558] Dynamic subtest eDP-1: SKIP (0.000s)
[378.052667] Subtest fbc-psr-dpms: SKIP (0.001s)
[378.115329] [094/133] (645s left) kms_getfb (getfb2-handle-protection)
[378.206296] Starting subtest: getfb2-handle-protection
[378.222909] Subtest getfb2-handle-protection: SUCCESS (0.018s)
[378.335582] [095/133] (645s left) api_intel_allocator (fork-simple-stress-signal)
[378.391495] Starting subtest: fork-simple-stress-signal
[383.848232] Subtest fork-simple-stress-signal: SUCCESS (5.404s)
[383.901986] [096/133] (639s left) kms_cursor_crc (cursor-rapid-movement-512x170)
[384.219356] Starting subtest: cursor-rapid-movement-512x170
[384.223838] Subtest cursor-rapid-movement-512x170: SKIP (0.001s)
[384.361557] [097/133] (639s left) kms_pm_rpm (basic-pci-d3-state)
[385.898980] Starting subtest: basic-pci-d3-state
[387.344205] Subtest basic-pci-d3-state: SUCCESS (1.447s)
[387.431317] [098/133] (636s left) perf_pmu (busy-accuracy-98)
[387.482444] Starting subtest: busy-accuracy-98
[387.484665] Starting dynamic subtest: rcs0
[390.520025] Dynamic subtest rcs0: SUCCESS (3.036s)
[390.532877] Starting dynamic subtest: bcs0
[393.625589] Dynamic subtest bcs0: SUCCESS (3.046s)
[393.639636] Starting dynamic subtest: vcs0
[396.658016] Dynamic subtest vcs0: SUCCESS (3.041s)
[396.672576] Starting dynamic subtest: vcs1
[399.698865] Dynamic subtest vcs1: SUCCESS (3.039s)
[399.710353] Starting dynamic subtest: vecs0
[402.737587] Dynamic subtest vecs0: SUCCESS (3.036s)
[402.749530] Starting dynamic subtest: ccs0
[405.788983] Dynamic subtest ccs0: SUCCESS (3.049s)
[405.791240] Subtest busy-accuracy-98: SUCCESS (18.262s)
[405.854190] [099/133] (617s left) gen3_render_tiledy_blits
[405.982076] [100/133] (617s left) perf_pmu (gt-awake)
[406.023891] Starting subtest: gt-awake
[414.652104] Subtest gt-awake: SUCCESS (8.628s)
[414.755722] [101/133] (608s left) kms_psr (pr-cursor-mmap-cpu)
[414.853634] Starting subtest: pr-cursor-mmap-cpu
[414.858314] Subtest pr-cursor-mmap-cpu: SKIP (0.000s)
[414.928401] [102/133] (608s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-mmap-wc)
[415.017766] Starting subtest: psr-1p-primscrn-pri-indfb-draw-mmap-wc
[421.991000] Subtest psr-1p-primscrn-pri-indfb-draw-mmap-wc: SUCCESS (6.976s)
[422.094176] [103/133] (601s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-shrfb-pgflip-blt)
[422.195776] Starting subtest: fbcpsr-2p-primscrn-shrfb-pgflip-blt
[422.200265] Subtest fbcpsr-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[422.279243] [104/133] (601s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-rc-ccs-cc)
[422.371286] Starting subtest: crc-primary-suspend-4-tiled-dg2-rc-ccs-cc
[422.373499] Starting dynamic subtest: pipe-A-eDP-1
[422.382390] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[422.393281] Starting dynamic subtest: pipe-B-eDP-1
[422.402240] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[422.411413] Starting dynamic subtest: pipe-C-eDP-1
[422.420187] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[422.429241] Starting dynamic subtest: pipe-D-eDP-1
[422.437336] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[422.441190] Subtest crc-primary-suspend-4-tiled-dg2-rc-ccs-cc: SKIP (0.004s)
[424.642999] [105/133] (599s left) gem_exec_alignment (pi)
[424.713714] Starting subtest: pi
[474.477383] Subtest pi: SUCCESS (49.749s)
[475.553376] [106/133] (548s left) kms_psr2_sf (pr-cursor-plane-move-continuous-exceed-fully-sf)
[475.708565] Starting subtest: pr-cursor-plane-move-continuous-exceed-fully-sf
[475.713223] Subtest pr-cursor-plane-move-continuous-exceed-fully-sf: SKIP (0.000s)
[475.786398] [107/133] (548s left) gem_exec_reloc (basic-write-cpu-noreloc)
[475.847838] Subtest basic-write-cpu-noreloc: SKIP (0.000s)
[475.914074] [108/133] (548s left) kms_cursor_legacy (cursora-vs-flipa-varying-size)
[476.035875] Starting subtest: cursorA-vs-flipA-varying-size
[487.199440] Subtest cursorA-vs-flipA-varying-size: SUCCESS (11.161s)
[488.045943] [109/133] (535s left) kms_frontbuffer_tracking (fbcpsr-1p-indfb-fliptrack-mmap-gtt)
[488.140969] Starting subtest: fbcpsr-1p-indfb-fliptrack-mmap-gtt
[488.145148] Subtest fbcpsr-1p-indfb-fliptrack-mmap-gtt: SKIP (0.000s)
[488.248255] [110/133] (535s left) kms_flip (bo-too-big-interruptible)
[488.342143] Starting subtest: bo-too-big-interruptible
[488.344460] Starting dynamic subtest: A-eDP1
[489.685159] Dynamic subtest A-eDP1: SUCCESS (1.342s)
[489.695081] Starting dynamic subtest: B-eDP1
[490.967222] Dynamic subtest B-eDP1: SUCCESS (1.280s)
[490.978801] Starting dynamic subtest: C-eDP1
[492.289126] Dynamic subtest C-eDP1: SUCCESS (1.321s)
[492.299088] Starting dynamic subtest: D-eDP1
[493.581743] Dynamic subtest D-eDP1: SUCCESS (1.289s)
[493.584543] Subtest bo-too-big-interruptible: SUCCESS (5.241s)
[494.761982] [111/133] (529s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-0-hflip)
[494.879492] Starting subtest: linear-max-hw-stride-32bpp-rotate-0-hflip
[494.883473] Subtest linear-max-hw-stride-32bpp-rotate-0-hflip: SKIP (0.000s)
[494.982720] [112/133] (529s left) sysfs_heartbeat_interval (idempotent)
[495.051081] Starting subtest: idempotent
[495.053485] Starting dynamic subtest: vecs0
[495.055857] Dynamic subtest vecs0: SUCCESS (0.001s)
[495.067279] Starting dynamic subtest: ccs0
[495.069146] Dynamic subtest ccs0: SUCCESS (0.001s)
[495.078734] Starting dynamic subtest: vcs0
[495.080642] Dynamic subtest vcs0: SUCCESS (0.000s)
[495.090380] Starting dynamic subtest: bcs0
[495.092347] Dynamic subtest bcs0: SUCCESS (0.001s)
[495.101764] Starting dynamic subtest: rcs0
[495.103978] Dynamic subtest rcs0: SUCCESS (0.000s)
[495.113551] Starting dynamic subtest: vcs1
[495.115468] Dynamic subtest vcs1: SUCCESS (0.000s)
[495.117358] Subtest idempotent: SUCCESS (0.008s)
[495.153671] [113/133] (528s left) gem_unfence_active_buffers
[495.321890] [114/133] (528s left) syncobj_wait (multi-wait-all-for-submit-unsubmitted-signaled)
[495.380099] Starting subtest: multi-wait-all-for-submit-unsubmitted-signaled
[495.487388] Subtest multi-wait-all-for-submit-unsubmitted-signaled: SUCCESS (0.107s)
[495.565732] [115/133] (528s left) gem_tiled_partial_pwrite_pread (writes)
[495.625988] Subtest writes: SKIP (0.000s)
[495.683564] [116/133] (528s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu)
[495.783738] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu
[502.661160] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu: SUCCESS (6.878s)
[502.770549] [117/133] (521s left) gem_exec_schedule (preempt-self)
[502.855813] Starting subtest: preempt-self
[502.858223] Starting dynamic subtest: rcs0
[502.866672] Dynamic subtest rcs0: SUCCESS (0.020s)
[502.878749] Starting dynamic subtest: bcs0
[502.888786] Dynamic subtest bcs0: SUCCESS (0.021s)
[502.898404] Starting dynamic subtest: vcs0
[502.910030] Dynamic subtest vcs0: SUCCESS (0.020s)
[502.919865] Starting dynamic subtest: vcs1
[502.928295] Dynamic subtest vcs1: SUCCESS (0.017s)
[502.937918] Starting dynamic subtest: vecs0
[502.945879] Dynamic subtest vecs0: SUCCESS (0.016s)
[502.955867] Starting dynamic subtest: ccs0
[502.966403] Dynamic subtest ccs0: SUCCESS (0.021s)
[502.968742] Subtest preempt-self: SUCCESS (0.120s)
[504.718099] [118/133] (519s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip)
[504.826103] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip
[505.643740] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip: SUCCESS (0.818s)
[505.837628] [119/133] (518s left) gem_ctx_isolation (preservation)
[505.901608] Starting subtest: preservation
[505.903864] Starting dynamic subtest: rcs0
[506.022817] Dynamic subtest rcs0: SUCCESS (0.122s)
[506.036151] Starting dynamic subtest: bcs0
[506.159055] Dynamic subtest bcs0: SUCCESS (0.136s)
[506.171696] Starting dynamic subtest: vcs0
[506.278544] Dynamic subtest vcs0: SUCCESS (0.119s)
[506.289201] Starting dynamic subtest: vcs1
[507.748359] Dynamic subtest vcs1: SUCCESS (1.467s)
[507.759486] Starting dynamic subtest: vecs0
[509.797394] Dynamic subtest vecs0: SUCCESS (2.047s)
[509.809232] Starting dynamic subtest: ccs0
[511.807678] Dynamic subtest ccs0: SUCCESS (2.008s)
[511.810982] Subtest preservation: SUCCESS (5.907s)
[512.043701] [120/133] (512s left) perf (per-context-mode-unprivileged)
[512.173020] Starting subtest: per-context-mode-unprivileged
[512.177295] Subtest per-context-mode-unprivileged: SKIP (0.000s)
[512.217051] [121/133] (512s left) kms_frontbuffer_tracking (fbc-1p-primscrn-shrfb-msflip-blt)
[512.310202] Starting subtest: fbc-1p-primscrn-shrfb-msflip-blt
[516.764282] Subtest fbc-1p-primscrn-shrfb-msflip-blt: SUCCESS (4.456s)
[517.958786] [122/133] (506s left) gem_render_copy (y-tiled-to-vebox-x-tiled)
[518.011315] Starting subtest: y-tiled-to-vebox-x-tiled
[518.015858] Subtest y-tiled-to-vebox-x-tiled: SKIP (0.000s)
[518.196530] [123/133] (506s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-blt)
[518.292791] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-blt
[518.296871] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-blt: SKIP (0.000s)
[518.384516] [124/133] (506s left) gem_mmap_offset (partial-remap)
[518.445981] Starting subtest: partial-remap
[518.448364] Starting dynamic subtest: smem0
[518.456622] Dynamic subtest smem0: SUCCESS (0.003s)
[518.458494] Subtest partial-remap: SUCCESS (0.004s)
[518.564567] [125/133] (506s left) gem_ctx_engines (execute-one)
[518.627268] Starting subtest: execute-one
[520.927330] Subtest execute-one: SUCCESS (2.304s)
[521.113768] [126/133] (503s left) core_setmaster (master-drop-set-user)
[521.187150] Starting subtest: master-drop-set-user
[521.199163] Subtest master-drop-set-user: SUCCESS (0.014s)
[521.235786] [127/133] (503s left) gem_exec_fence (long-history)
[521.732722] Starting subtest: long-history
[529.360067] Subtest long-history: SUCCESS (7.630s)
[529.959749] [FACT gem_exec_fence (long-history)] new: kernel.kmod_is_loaded.vgem: true
[529.963203] [128/133] (494s left) kms_explicit_fence (multiplane-atomic-fence-wait)
[530.110634] Starting subtest: multiplane-atomic-fence-wait
[530.431732] Subtest multiplane-atomic-fence-wait: SUCCESS (0.322s)
[531.559708] [129/133] (493s left) gem_ccs (ctrl-surf-copy)
[531.621881] Starting subtest: ctrl-surf-copy
[531.627060] Subtest ctrl-surf-copy: SKIP (0.000s)
[531.723494] [130/133] (493s left) kms_psr2_sf (fbc-pr-plane-move-sf-dmg-area)
[531.824828] Starting subtest: fbc-pr-plane-move-sf-dmg-area
[531.829296] Subtest fbc-pr-plane-move-sf-dmg-area: SKIP (0.000s)
[531.899961] [131/133] (492s left) kms_ccs (crc-sprite-planes-basic-4-tiled-dg2-mc-ccs)
[531.990256] Starting subtest: crc-sprite-planes-basic-4-tiled-dg2-mc-ccs
[531.992559] Starting dynamic subtest: pipe-A-eDP-1
[532.049919] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[532.059795] Starting dynamic subtest: pipe-B-eDP-1
[532.117165] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[532.128710] Starting dynamic subtest: pipe-C-eDP-1
[532.185833] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[532.197216] Starting dynamic subtest: pipe-D-eDP-1
[532.253783] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[532.257894] Subtest crc-sprite-planes-basic-4-tiled-dg2-mc-ccs: SKIP (0.008s)
[534.258597] [132/133] (490s left) kms_lease (lease-unleased-connector)
[534.359460] Starting subtest: lease-unleased-connector
[534.361785] Starting dynamic subtest: pipe-A-eDP-1
[534.367158] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.006s)
[534.385615] Starting dynamic subtest: pipe-B-eDP-1
[534.388058] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.007s)
[534.409914] Starting dynamic subtest: pipe-C-eDP-1
[534.412259] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.006s)
[534.432337] Starting dynamic subtest: pipe-D-eDP-1
[534.435026] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.006s)
[534.437695] Subtest lease-unleased-connector: SUCCESS (0.029s)
[534.495011] [133/133] (490s left) gem_mmap (short-mmap)
[534.550628] Subtest short-mmap: SKIP (0.000s)
[534.610160] Closing watchdogs
results: parsing output: 0/ for test: syncobj_timeline
results: parsing output: 1/ for test: kms_frontbuffer_tracking
results: parsing output: 2/ for test: kms_joiner
results: parsing output: 3/ for test: kms_plane_scaling
results: parsing output: 4/ for test: gem_exec_schedule
results: parsing output: 5/ for test: syncobj_timeline
results: parsing output: 6/ for test: gem_eio
results: parsing output: 7/ for test: gem_mmap_gtt
results: parsing output: 8/ for test: kms_psr
results: parsing output: 9/ for test: kms_ccs
results: parsing output: 10/ for test: i915_hangman
results: parsing output: 11/ for test: kms_frontbuffer_tracking
results: parsing output: 12/ for test: gem_exec_params
results: parsing output: 13/ for test: kms_plane_alpha_blend
results: parsing output: 14/ for test: kms_content_protection
results: parsing output: 15/ for test: gem_lmem_swapping
results: parsing output: 16/ for test: kms_pm_rpm
results: parsing output: 17/ for test: kms_color
results: parsing output: 18/ for test: kms_flip
results: parsing output: 19/ for test: kms_busy
results: parsing output: 20/ for test: kms_vblank
results: parsing output: 21/ for test: kms_plane
results: parsing output: 22/ for test: kms_psr2_sf
results: parsing output: 23/ for test: gem_render_copy
results: parsing output: 24/ for test: kms_ccs
results: parsing output: 25/ for test: kms_psr
results: parsing output: 26/ for test: gen9_exec_parse
results: parsing output: 27/ for test: gem_tiled_pread_pwrite
results: parsing output: 28/ for test: gem_ctx_persistence
results: parsing output: 29/ for test: kms_big_fb
results: parsing output: 30/ for test: api_intel_bb
results: parsing output: 31/ for test: kms_flip_scaled_crc
results: parsing output: 32/ for test: gem_exec_balancer
results: parsing output: 33/ for test: kms_atomic_interruptible
results: parsing output: 34/ for test: gem_userptr_blits
results: parsing output: 35/ for test: kms_cursor_legacy
results: parsing output: 36/ for test: kms_cursor_edge_walk
results: parsing output: 37/ for test: kms_frontbuffer_tracking
results: parsing output: 38/ for test: gem_spin_batch
results: parsing output: 39/ for test: kms_frontbuffer_tracking
results: parsing output: 40/ for test: kms_chamelium_hpd
results: parsing output: 41/ for test: kms_chamelium_color
results: parsing output: 42/ for test: kms_flip
results: parsing output: 43/ for test: kms_big_fb
results: parsing output: 44/ for test: kms_frontbuffer_tracking
results: parsing output: 45/ for test: sriov_basic
results: parsing output: 46/ for test: kms_plane_scaling
results: parsing output: 47/ for test: kms_async_flips
results: parsing output: 48/ for test: syncobj_eventfd
results: parsing output: 49/ for test: kms_plane
results: parsing output: 50/ for test: kms_flip
results: parsing output: 51/ for test: gen9_exec_parse
results: parsing output: 52/ for test: kms_big_fb
results: parsing output: 53/ for test: kms_display_modes
results: parsing output: 54/ for test: gem_lmem_swapping
results: parsing output: 55/ for test: gem_ctx_param
results: parsing output: 56/ for test: gem_exec_gttfill
results: parsing output: 57/ for test: kms_atomic_transition
results: parsing output: 58/ for test: syncobj_timeline
results: parsing output: 59/ for test: gem_exec_reloc
results: parsing output: 60/ for test: gem_mmap
results: parsing output: 61/ for test: gem_userptr_blits
results: parsing output: 62/ for test: i915_suspend
results: parsing output: 63/ for test: gem_fenced_exec_thrash
results: parsing output: 64/ for test: prime_mmap_coherency
results: parsing output: 65/ for test: kms_frontbuffer_tracking
results: parsing output: 66/ for test: kms_rotation_crc
results: parsing output: 67/ for test: gem_pxp
results: parsing output: 68/ for test: syncobj_timeline
results: parsing output: 69/ for test: gem_exec_whisper
results: parsing output: 70/ for test: gem_exec_reloc
results: parsing output: 71/ for test: kms_frontbuffer_tracking
results: parsing output: 72/ for test: gem_ctx_param
results: parsing output: 73/ for test: kms_flip
results: parsing output: 74/ for test: kms_cursor_crc
results: parsing output: 75/ for test: kms_selftest
results: parsing output: 76/ for test: gem_exec_basic
results: parsing output: 77/ for test: gem_userptr_blits
results: parsing output: 78/ for test: i915_pm_rpm
results: parsing output: 79/ for test: kms_frontbuffer_tracking
results: parsing output: 80/ for test: kms_ccs
results: parsing output: 81/ for test: kms_cursor_legacy
results: parsing output: 82/ for test: kms_scaling_modes
results: parsing output: 83/ for test: kms_flip_scaled_crc
results: parsing output: 84/ for test: kms_force_connector_basic
results: parsing output: 85/ for test: gem_userptr_blits
results: parsing output: 86/ for test: kms_frontbuffer_tracking
results: parsing output: 87/ for test: gem_exec_alignment
results: parsing output: 88/ for test: prime_mmap
results: parsing output: 89/ for test: gem_exec_reloc
results: parsing output: 90/ for test: kms_addfb_basic
results: parsing output: 91/ for test: kms_big_fb
results: parsing output: 92/ for test: kms_psr
results: parsing output: 93/ for test: kms_getfb
results: parsing output: 94/ for test: api_intel_allocator
results: parsing output: 95/ for test: kms_cursor_crc
results: parsing output: 96/ for test: kms_pm_rpm
results: parsing output: 97/ for test: perf_pmu
results: parsing output: 98/ for test: gen3_render_tiledy_blits
results: parsing output: 99/ for test: perf_pmu
results: parsing output: 100/ for test: kms_psr
results: parsing output: 101/ for test: kms_frontbuffer_tracking
results: parsing output: 102/ for test: kms_frontbuffer_tracking
results: parsing output: 103/ for test: kms_ccs
results: parsing output: 104/ for test: gem_exec_alignment
results: parsing output: 105/ for test: kms_psr2_sf
results: parsing output: 106/ for test: gem_exec_reloc
results: parsing output: 107/ for test: kms_cursor_legacy
results: parsing output: 108/ for test: kms_frontbuffer_tracking
results: parsing output: 109/ for test: kms_flip
results: parsing output: 110/ for test: kms_big_fb
results: parsing output: 111/ for test: sysfs_heartbeat_interval
results: parsing output: 112/ for test: gem_unfence_active_buffers
results: parsing output: 113/ for test: syncobj_wait
results: parsing output: 114/ for test: gem_tiled_partial_pwrite_pread
results: parsing output: 115/ for test: kms_frontbuffer_tracking
results: parsing output: 116/ for test: gem_exec_schedule
results: parsing output: 117/ for test: kms_big_fb
results: parsing output: 118/ for test: gem_ctx_isolation
results: parsing output: 119/ for test: perf
results: parsing output: 120/ for test: kms_frontbuffer_tracking
results: parsing output: 121/ for test: gem_render_copy
results: parsing output: 122/ for test: kms_frontbuffer_tracking
results: parsing output: 123/ for test: gem_mmap_offset
results: parsing output: 124/ for test: gem_ctx_engines
results: parsing output: 125/ for test: core_setmaster
results: parsing output: 126/ for test: gem_exec_fence
results: parsing output: 127/ for test: kms_explicit_fence
results: parsing output: 128/ for test: gem_ccs
results: parsing output: 129/ for test: kms_psr2_sf
results: parsing output: 130/ for test: kms_ccs
results: parsing output: 131/ for test: kms_lease
results: parsing output: 132/ for test: gem_mmap
Done.