[56.791864] Initializing watchdogs
[56.791928]   /dev/watchdog0
[56.808350] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics]
[56.813791] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[56.816277] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[56.818411] [001/130] (960s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-render)
[56.917152] Starting subtest: psr-2p-primscrn-spr-indfb-draw-render
[56.918963] Subtest psr-2p-primscrn-spr-indfb-draw-render: SKIP (0.000s)
[57.028722] [002/130] (960s left) gem_workarounds (suspend-resume-fd)
[57.097849] Starting subtest: suspend-resume-fd
[73.919721] Subtest suspend-resume-fd: SUCCESS (1.685s)
[81.064069] [003/130] (943s left) gem_render_copy (yf-tiled)
[81.121399] Starting subtest: yf-tiled
[81.123477] Subtest yf-tiled: SKIP (0.000s)
[81.297791] [004/130] (943s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-draw-pwrite)
[81.392122] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-draw-pwrite
[81.393990] Subtest fbcpsr-2p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[81.475073] [005/130] (942s left) sw_sync (sync_multi_producer_single_consumer)
[81.503532] Starting subtest: sync_multi_producer_single_consumer
[82.598727] Subtest sync_multi_producer_single_consumer: SUCCESS (1.075s)
[82.643100] [006/130] (941s left) kms_frontbuffer_tracking (fbc-1p-rte)
[82.723710] Starting subtest: fbc-1p-rte
[88.655259] Subtest fbc-1p-rte: SUCCESS (5.873s)
[89.820725] [007/130] (934s left) i915_suspend (fence-restore-tiled2untiled)
[89.872414] Starting subtest: fence-restore-tiled2untiled
[89.874429] Subtest fence-restore-tiled2untiled: SKIP (0.000s)
[89.969974] [008/130] (934s left) kms_cursor_crc (cursor-tearing-framebuffer-change)
[90.081414] Starting subtest: cursor-tearing-framebuffer-change
[90.082501] Starting dynamic subtest: pipe-A-eDP-1
[90.678552] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.594s)
[90.686607] Starting dynamic subtest: pipe-D-eDP-1
[91.866287] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.181s)
[91.867319] Subtest cursor-tearing-framebuffer-change: SUCCESS (1.777s)
[92.701369] [009/130] (931s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180)
[92.793521] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180
[93.878724] Subtest x-tiled-max-hw-stride-32bpp-rotate-180: SUCCESS (1.082s)
[94.003010] [010/130] (930s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-16bpp-ytile-downscaling)
[94.093202] Starting subtest: flip-64bpp-ytile-to-16bpp-ytile-downscaling
[94.094922] Subtest flip-64bpp-ytile-to-16bpp-ytile-downscaling: SKIP (0.000s)
[94.157394] [011/130] (930s left) gem_userptr_blits (invalid-null-pointer)
[94.205821] Starting subtest: invalid-null-pointer
[94.206972] Subtest invalid-null-pointer: SUCCESS (0.001s)
[94.313994] [012/130] (930s left) gem_pxp (fail-invalid-protected-context)
[94.432217] Starting subtest: fail-invalid-protected-context
[94.433458] Subtest fail-invalid-protected-context: SUCCESS (0.000s)
[94.532731] [013/130] (930s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu)
[94.628391] Starting subtest: fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu
[94.630205] Subtest fbcpsr-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[94.716337] [014/130] (930s left) kms_big_fb (linear-8bpp-rotate-180)
[94.822212] Starting subtest: linear-8bpp-rotate-180
[96.071930] Subtest linear-8bpp-rotate-180: SUCCESS (1.247s)
[96.179968] [015/130] (928s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-mmap-cpu)
[96.265809] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-mmap-cpu
[100.312713] Subtest fbc-1p-offscreen-pri-shrfb-draw-mmap-cpu: SUCCESS (4.038s)
[101.458653] [016/130] (923s left) kms_ccs (crc-primary-basic-4-tiled-mtl-rc-ccs-cc)
[101.540999] Starting subtest: crc-primary-basic-4-tiled-mtl-rc-ccs-cc
[101.542604] Starting dynamic subtest: pipe-A-eDP-1
[102.499496] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.946s)
[102.512793] Starting dynamic subtest: pipe-B-eDP-1
[104.191938] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.696s)
[104.201308] Starting dynamic subtest: pipe-C-eDP-1
[105.705953] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.509s)
[105.713981] Starting dynamic subtest: pipe-D-eDP-1
[107.244890] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.535s)
[107.245955] Subtest crc-primary-basic-4-tiled-mtl-rc-ccs-cc: SUCCESS (5.692s)
[108.392128] [017/130] (916s left) gem_exec_params (invalid-bsd2-flag-on-vebox)
[108.441630] Starting subtest: invalid-bsd2-flag-on-vebox
[108.442776] Subtest invalid-bsd2-flag-on-vebox: SUCCESS (0.000s)
[108.546361] [018/130] (916s left) kms_psr (psr-no-drrs)
[108.632401] Starting subtest: psr-no-drrs
[108.633297] Starting dynamic subtest: eDP-1
[110.278287] Dynamic subtest eDP-1: SUCCESS (1.644s)
[110.279241] Subtest psr-no-drrs: SUCCESS (1.645s)
[111.171760] [019/130] (913s left) kms_getfb (getfb-handle-valid)
[111.252691] Starting subtest: getfb-handle-valid
[111.253883] Subtest getfb-handle-valid: SUCCESS (0.000s)
[111.351265] [020/130] (913s left) kms_pipe_stress (stress-xrgb8888-xtiled)
[111.439973] Starting subtest: stress-xrgb8888-xtiled
[117.392307] Subtest stress-xrgb8888-xtiled: SUCCESS (5.953s)
[117.433687] [021/130] (907s left) kms_psr (fbc-psr-cursor-mmap-gtt)
[117.519695] Starting subtest: fbc-psr-cursor-mmap-gtt
[117.520614] Starting dynamic subtest: eDP-1
[117.522311] Dynamic subtest eDP-1: SKIP (0.000s)
[117.524014] Subtest fbc-psr-cursor-mmap-gtt: SKIP (0.001s)
[117.588477] [022/130] (907s left) gem_flink_basic (bad-open)
[117.632276] Starting subtest: bad-open
[117.633230] Subtest bad-open: SUCCESS (0.000s)
[117.725800] [023/130] (907s left) kms_vblank (wait-busy)
[117.807873] Starting subtest: wait-busy
[117.808704] Starting dynamic subtest: pipe-A-eDP-1
[119.683964] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.875s)
[119.694180] Starting dynamic subtest: pipe-D-eDP-1
[122.228633] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.544s)
[122.229508] Subtest wait-busy: SUCCESS (4.423s)
[123.014874] [024/130] (902s left) kms_cursor_legacy (cursorb-vs-flipb-toggle)
[123.127005] Starting subtest: cursorB-vs-flipB-toggle
[123.128863] Subtest cursorB-vs-flipB-toggle: SKIP (0.001s)
[123.264178] [025/130] (901s left) kms_flip (2x-modeset-vs-vblank-race)
[123.356976] Starting subtest: 2x-modeset-vs-vblank-race
[123.368124] Subtest 2x-modeset-vs-vblank-race: SKIP (0.011s)
[123.453937] [026/130] (901s left) kms_psr (pr-cursor-blt)
[123.543416] Starting subtest: pr-cursor-blt
[123.545169] Subtest pr-cursor-blt: SKIP (0.000s)
[123.608801] [027/130] (901s left) kms_addfb_basic (clobberred-modifier)
[123.652309] Starting subtest: clobberred-modifier
[123.654456] Subtest clobberred-modifier: SKIP (0.000s)
[123.813956] [028/130] (901s left) gem_exec_schedule (smoketest)
[124.005082] Starting subtest: smoketest
[124.006065] Starting dynamic subtest: rcs0
[129.560551] Dynamic subtest rcs0: SUCCESS (5.491s)
[129.570627] Starting dynamic subtest: bcs0
[135.055211] Dynamic subtest bcs0: SUCCESS (5.495s)
[135.066694] Starting dynamic subtest: vcs0
[140.544955] Dynamic subtest vcs0: SUCCESS (5.487s)
[140.560616] Starting dynamic subtest: vcs1
[146.039538] Dynamic subtest vcs1: SUCCESS (5.491s)
[146.049544] Starting dynamic subtest: vecs0
[151.534876] Dynamic subtest vecs0: SUCCESS (5.497s)
[151.546678] Starting dynamic subtest: ccs0
[156.999384] Dynamic subtest ccs0: SUCCESS (5.499s)
[157.000407] Subtest smoketest: SUCCESS (32.967s)
[157.165207] [029/130] (868s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-move)
[157.267521] Starting subtest: psr-2p-primscrn-cur-indfb-move
[157.269225] Subtest psr-2p-primscrn-cur-indfb-move: SKIP (0.000s)
[157.366830] [030/130] (867s left) kms_psr (psr2-primary-render)
[157.463112] Starting subtest: psr2-primary-render
[157.464092] Starting dynamic subtest: eDP-1
[159.224635] Dynamic subtest eDP-1: SUCCESS (1.760s)
[159.225624] Subtest psr2-primary-render: SUCCESS (1.761s)
[160.093326] [031/130] (865s left) gem_lmem_swapping (verify-random)
[160.128961] Subtest verify-random: SKIP (0.000s)
[160.163781] [032/130] (865s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-blt)
[160.256406] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-blt
[160.257992] Subtest fbc-2p-scndscrn-spr-indfb-draw-blt: SKIP (0.000s)
[160.372529] [033/130] (864s left) kms_flip (2x-flip-vs-dpms-on-nop-interruptible)
[160.450537] Starting subtest: 2x-flip-vs-dpms-on-nop-interruptible
[160.463171] Subtest 2x-flip-vs-dpms-on-nop-interruptible: SKIP (0.011s)
[160.537166] [034/130] (864s left) kms_psr2_sf (fbc-psr2-cursor-plane-update-sf)
[160.627644] Starting subtest: fbc-psr2-cursor-plane-update-sf
[160.628642] Starting dynamic subtest: pipe-A-eDP-1
[160.707792] Dynamic subtest pipe-A-eDP-1: SKIP (0.078s)
[160.718095] Starting dynamic subtest: pipe-B-eDP-1
[161.879389] Dynamic subtest pipe-B-eDP-1: SKIP (1.170s)
[161.881231] Subtest fbc-psr2-cursor-plane-update-sf: SKIP (1.251s)
[163.059088] [035/130] (862s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-render)
[163.143443] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-render
[167.677263] Subtest fbc-1p-primscrn-pri-shrfb-draw-render: SUCCESS (4.532s)
[168.862186] [036/130] (856s left) gem_exec_store (cachelines)
[168.911013] Starting subtest: cachelines
[168.912092] Starting dynamic subtest: rcs0
[168.982383] Dynamic subtest rcs0: SUCCESS (0.071s)
[169.002404] Starting dynamic subtest: bcs0
[169.045232] Dynamic subtest bcs0: SUCCESS (0.061s)
[169.055291] Starting dynamic subtest: vcs0
[169.102619] Dynamic subtest vcs0: SUCCESS (0.056s)
[169.112569] Starting dynamic subtest: vcs1
[169.162063] Dynamic subtest vcs1: SUCCESS (0.058s)
[169.173362] Starting dynamic subtest: vecs0
[169.224487] Dynamic subtest vecs0: SUCCESS (0.061s)
[169.236289] Starting dynamic subtest: ccs0
[169.291610] Dynamic subtest ccs0: SUCCESS (0.065s)
[169.292929] Subtest cachelines: SUCCESS (0.381s)
[169.480358] [037/130] (856s left) kms_chamelium_hpd (vga-hpd)
[169.882063] Subtest vga-hpd: SKIP (0.000s)
[170.670000] [038/130] (854s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-0)
[170.761382] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-0
[170.763389] Subtest yf-tiled-max-hw-stride-64bpp-rotate-0: SKIP (0.000s)
[170.853523] [039/130] (854s left) gem_softpin (allocator-basic)
[170.910676] Starting subtest: allocator-basic
[170.978289] Subtest allocator-basic: SUCCESS (0.069s)
[171.084728] [040/130] (854s left) perf_pmu (init-wait)
[171.127547] Starting subtest: init-wait
[171.128502] Starting dynamic subtest: rcs0
[171.130560] Dynamic subtest rcs0: SUCCESS (0.002s)
[171.139491] Starting dynamic subtest: bcs0
[171.140421] Dynamic subtest bcs0: SUCCESS (0.000s)
[171.147903] Starting dynamic subtest: vcs0
[171.148967] Dynamic subtest vcs0: SUCCESS (0.001s)
[171.156663] Starting dynamic subtest: vcs1
[171.157593] Dynamic subtest vcs1: SUCCESS (0.001s)
[171.165061] Starting dynamic subtest: vecs0
[171.165944] Dynamic subtest vecs0: SUCCESS (0.001s)
[171.173358] Starting dynamic subtest: ccs0
[171.174256] Dynamic subtest ccs0: SUCCESS (0.000s)
[171.175094] Subtest init-wait: SUCCESS (0.008s)
[171.258738] [041/130] (854s left) gem_ctx_param (invalid-set-ringsize)
[171.303904] Starting subtest: invalid-set-ringsize
[171.304971] Subtest invalid-set-ringsize: SUCCESS (0.000s)
[171.366855] [042/130] (854s left) kms_ccs (bad-rotation-90-4-tiled-dg2-rc-ccs-cc)
[171.459187] Starting subtest: bad-rotation-90-4-tiled-dg2-rc-ccs-cc
[171.460142] Starting dynamic subtest: pipe-A-eDP-1
[171.470552] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[171.479198] Starting dynamic subtest: pipe-B-eDP-1
[171.488315] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[171.498749] Starting dynamic subtest: pipe-C-eDP-1
[171.507014] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[171.514778] Starting dynamic subtest: pipe-D-eDP-1
[171.522856] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[171.524471] Subtest bad-rotation-90-4-tiled-dg2-rc-ccs-cc: SKIP (0.004s)
[173.756117] [043/130] (851s left) prime_self_import (basic-llseek-size)
[173.788121] Starting subtest: basic-llseek-size
[173.813878] Subtest basic-llseek-size: SUCCESS (0.028s)
[173.918092] [044/130] (851s left) kms_content_protection (type1)
[174.057255] Starting subtest: type1
[174.059673] Subtest type1: SKIP (0.000s)
[174.176803] [045/130] (851s left) kms_plane (pixel-format-y-tiled-gen12-rc-ccs-cc-modifier-source-clamping)
[174.255632] Starting subtest: pixel-format-y-tiled-gen12-rc-ccs-cc-modifier-source-clamping
[174.257631] Subtest pixel-format-y-tiled-gen12-rc-ccs-cc-modifier-source-clamping: SKIP (0.000s)
[174.319272] [046/130] (851s left) syncobj_timeline (wait-all-for-submit-snapshot)
[174.373691] Starting subtest: wait-all-for-submit-snapshot
[174.456515] Subtest wait-all-for-submit-snapshot: SUCCESS (0.082s)
[174.535421] [047/130] (851s left) kms_big_fb (x-tiled-64bpp-rotate-180)
[174.633184] Starting subtest: x-tiled-64bpp-rotate-180
[176.179675] Subtest x-tiled-64bpp-rotate-180: SUCCESS (1.546s)
[176.367341] [048/130] (849s left) kms_plane_lowres (tiling-y)
[176.453373] Starting subtest: tiling-y
[176.455285] Subtest tiling-y: SKIP (0.000s)
[176.517246] [049/130] (849s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-0-hflip)
[176.619237] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-0-hflip
[176.621098] Subtest y-tiled-max-hw-stride-64bpp-rotate-0-hflip: SKIP (0.000s)
[176.718562] [050/130] (849s left) gem_mmap_gtt (basic-small-copy-odd)
[176.774070] Subtest basic-small-copy-odd: SKIP (0.000s)
[176.834116] [051/130] (849s left) gem_mmap_wc (read-write-distinct)
[176.882891] Subtest read-write-distinct: SKIP (0.000s)
[176.945321] [052/130] (849s left) api_intel_bb (intel-bb-blit-x)
[176.993315] Starting subtest: intel-bb-blit-x
[181.173769] Subtest intel-bb-blit-x: SUCCESS (4.173s)
[181.280114] [053/130] (844s left) kms_plane_scaling (plane-upscale-20x20-with-rotation)
[181.365052] Starting subtest: plane-upscale-20x20-with-rotation
[181.365984] Starting dynamic subtest: pipe-A
[181.590778] Dynamic subtest pipe-A: SUCCESS (0.227s)
[181.599491] Starting dynamic subtest: pipe-B
[182.846803] Dynamic subtest pipe-B: SUCCESS (1.256s)
[182.854680] Starting dynamic subtest: pipe-C
[184.187279] Dynamic subtest pipe-C: SUCCESS (1.340s)
[184.195387] Starting dynamic subtest: pipe-D
[185.527704] Dynamic subtest pipe-D: SUCCESS (1.340s)
[185.528804] Subtest plane-upscale-20x20-with-rotation: SUCCESS (4.165s)
[186.708062] [054/130] (839s left) gem_render_copy_redux (flink-interruptible)
[186.752219] Starting subtest: flink-interruptible
[187.484406] Subtest flink-interruptible: SUCCESS (0.732s)
[187.609710] [055/130] (838s left) kms_frontbuffer_tracking (fbcpsr-suspend)
[187.700139] Starting subtest: fbcpsr-suspend
[228.551872] Subtest fbcpsr-suspend: SUCCESS (10.880s)
[232.724508] [056/130] (797s left) kms_flip (basic-flip-vs-modeset)
[232.817255] Starting subtest: basic-flip-vs-modeset
[232.819476] Starting dynamic subtest: A-eDP1
[235.487257] Dynamic subtest A-eDP1: SUCCESS (2.614s)
[235.495778] Starting dynamic subtest: B-eDP1
[237.665259] Dynamic subtest B-eDP1: SUCCESS (2.143s)
[237.673372] Starting dynamic subtest: C-eDP1
[239.856312] Dynamic subtest C-eDP1: SUCCESS (2.164s)
[239.864659] Starting dynamic subtest: D-eDP1
[242.035832] Dynamic subtest D-eDP1: SUCCESS (2.160s)
[242.038237] Subtest basic-flip-vs-modeset: SUCCESS (9.089s)
[242.824268] [057/130] (787s left) gem_spin_batch (legacy-resubmit-new)
[242.885272] Starting subtest: legacy-resubmit-new
[242.886354] Starting dynamic subtest: default
[242.893560] Dynamic subtest default: SUCCESS (0.008s)
[242.902128] Starting dynamic subtest: render
[242.903082] Dynamic subtest render: SUCCESS (0.003s)
[242.911864] Starting dynamic subtest: bsd
[242.913091] Dynamic subtest bsd: SUCCESS (0.004s)
[242.926412] Starting dynamic subtest: bsd1
[242.927494] Dynamic subtest bsd1: SUCCESS (0.004s)
[242.935201] Starting dynamic subtest: bsd2
[242.936171] Dynamic subtest bsd2: SUCCESS (0.004s)
[242.943548] Starting dynamic subtest: blt
[242.944459] Dynamic subtest blt: SUCCESS (0.004s)
[242.952151] Starting dynamic subtest: vebox
[242.953048] Dynamic subtest vebox: SUCCESS (0.004s)
[242.953894] Subtest legacy-resubmit-new: SUCCESS (0.039s)
[244.453208] [058/130] (785s left) gem_exec_basic (basic)
[244.510893] Starting subtest: basic
[244.512114] Starting dynamic subtest: rcs0-smem
[244.514903] Dynamic subtest rcs0-smem: SUCCESS (0.003s)
[244.523878] Starting dynamic subtest: bcs0-smem
[244.524779] Dynamic subtest bcs0-smem: SUCCESS (0.002s)
[244.532731] Starting dynamic subtest: vcs0-smem
[244.533631] Dynamic subtest vcs0-smem: SUCCESS (0.002s)
[244.541858] Starting dynamic subtest: vcs1-smem
[244.542778] Dynamic subtest vcs1-smem: SUCCESS (0.001s)
[244.550408] Starting dynamic subtest: vecs0-smem
[244.551296] Dynamic subtest vecs0-smem: SUCCESS (0.002s)
[244.558935] Starting dynamic subtest: ccs0-smem
[244.559785] Dynamic subtest ccs0-smem: SUCCESS (0.002s)
[244.560697] Subtest basic: SUCCESS (0.015s)
[246.435316] [059/130] (783s left) kms_pm_dc (dc9-dpms)
[247.542339] Starting subtest: dc9-dpms
[248.966572] Subtest dc9-dpms: SUCCESS (1.419s)
[249.032937] [060/130] (781s left) gem_exec_schedule (preempt-engines)
[249.089301] Starting subtest: preempt-engines
[249.090159] Starting dynamic subtest: rcs0
[251.373459] Dynamic subtest rcs0: SUCCESS (2.269s)
[251.383695] Starting dynamic subtest: bcs0
[253.669725] Dynamic subtest bcs0: SUCCESS (2.252s)
[253.680324] Starting dynamic subtest: vcs0
[256.011422] Dynamic subtest vcs0: SUCCESS (2.335s)
[256.029180] Starting dynamic subtest: vcs1
[258.310885] Dynamic subtest vcs1: SUCCESS (2.294s)
[258.320654] Starting dynamic subtest: vecs0
[260.599628] Dynamic subtest vecs0: SUCCESS (2.283s)
[260.613617] Starting dynamic subtest: ccs0
[262.983786] Dynamic subtest ccs0: SUCCESS (2.380s)
[262.985553] Subtest preempt-engines: SUCCESS (13.826s)
[263.238143] [061/130] (767s left) vgem_basic (bad-flag)
[263.338250] Starting subtest: bad-flag
[263.339188] Subtest bad-flag: SUCCESS (0.000s)
[263.399787] [FACT vgem_basic (bad-flag)] new: kernel.kmod_is_loaded.vgem: true
[263.401737] [062/130] (766s left) gem_userptr_blits (usage-restrictions)
[263.462265] Starting subtest: usage-restrictions
[263.463168] Subtest usage-restrictions: SUCCESS (0.000s)
[263.577000] [063/130] (766s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-render)
[263.670516] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-render
[263.672307] Subtest psr-2p-scndscrn-cur-indfb-draw-render: SKIP (0.000s)
[263.781109] [064/130] (766s left) kms_cursor_crc (cursor-sliding-128x128)
[263.987127] Starting subtest: cursor-sliding-128x128
[263.990767] Starting dynamic subtest: pipe-A-eDP-1
[267.232654] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.241s)
[267.264134] Starting dynamic subtest: pipe-D-eDP-1
[271.142460] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.887s)
[271.143425] Subtest cursor-sliding-128x128: SUCCESS (7.155s)
[271.985030] [065/130] (758s left) gem_exec_fence (syncobj-invalid-flags)
[272.427166] Starting subtest: syncobj-invalid-flags
[272.428207] Subtest syncobj-invalid-flags: SUCCESS (0.000s)
[273.478112] [066/130] (757s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-onoff)
[273.565045] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-onoff
[273.566727] Subtest fbcpsr-2p-primscrn-cur-indfb-onoff: SKIP (0.000s)
[273.686825] [067/130] (756s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu)
[273.771648] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu
[280.968902] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu: SUCCESS (7.197s)
[281.078416] [068/130] (749s left) gem_lmem_swapping (parallel-random-engines)
[281.118219] Subtest parallel-random-engines: SKIP (0.000s)
[281.164624] [069/130] (749s left) syncobj_timeline (etime-multi-wait-all-for-submit-unsubmitted-submitted-signa
[281.222343] Starting subtest: etime-multi-wait-all-for-submit-unsubmitted-submitted-signaled
[281.324317] Subtest etime-multi-wait-all-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.101s)
[281.396904] [070/130] (749s left) gem_exec_params (batch-first)
[281.441165] Starting subtest: batch-first
[281.447357] Subtest batch-first: SUCCESS (0.006s)
[281.564833] [071/130] (749s left) kms_flip (flip-vs-expired-vblank)
[281.647780] Starting subtest: flip-vs-expired-vblank
[281.649763] Starting dynamic subtest: A-eDP1
[290.338019] Dynamic subtest A-eDP1: SUCCESS (8.661s)
[290.346773] Starting dynamic subtest: B-eDP1
[298.974756] Dynamic subtest B-eDP1: SUCCESS (8.631s)
[298.986291] Starting dynamic subtest: C-eDP1
[307.607891] Dynamic subtest C-eDP1: SUCCESS (8.618s)
[307.617618] Starting dynamic subtest: D-eDP1
[316.241411] Dynamic subtest D-eDP1: SUCCESS (8.628s)
[316.242426] Subtest flip-vs-expired-vblank: SUCCESS (34.551s)
[317.367233] [072/130] (713s left) i915_drm_fdinfo (virtual-busy-hang)
[317.403361] Starting subtest: virtual-busy-hang
[317.405292] Subtest virtual-busy-hang: SKIP (0.000s)
[317.466078] [073/130] (713s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-0-async-flip)
[317.562348] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-0-async-flip
[317.564355] Subtest y-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SKIP (0.000s)
[317.683322] [074/130] (713s left) gem_eio (execbuf)
[317.900825] Starting subtest: execbuf
[318.235726] Subtest execbuf: SUCCESS (0.335s)
[318.343415] [075/130] (712s left) gem_close_race (multigpu-basic-threads)
[318.399412] Starting subtest: multigpu-basic-threads
[318.401628] Subtest multigpu-basic-threads: SKIP (0.000s)
[318.628463] [076/130] (712s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-mmap-gtt)
[318.724037] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-mmap-gtt
[318.725996] Subtest fbc-2p-scndscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[318.835102] [077/130] (712s left) kms_invalid_mode (bad-vtotal)
[318.935281] Starting subtest: bad-vtotal
[318.936205] Starting dynamic subtest: pipe-A-eDP-1
[319.220107] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.284s)
[319.229086] Starting dynamic subtest: pipe-B-eDP-1
[319.229897] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[319.237762] Starting dynamic subtest: pipe-C-eDP-1
[319.238804] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[319.247021] Starting dynamic subtest: pipe-D-eDP-1
[319.248004] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[319.248897] Subtest bad-vtotal: SUCCESS (0.290s)
[320.020924] [078/130] (710s left) kms_flip (plain-flip-ts-check-interruptible)
[320.113828] Starting subtest: plain-flip-ts-check-interruptible
[320.118736] Starting dynamic subtest: A-eDP1
[329.042059] Dynamic subtest A-eDP1: SUCCESS (8.895s)
[329.051817] Starting dynamic subtest: B-eDP1
[337.877866] Dynamic subtest B-eDP1: SUCCESS (8.836s)
[337.887229] Starting dynamic subtest: C-eDP1
[346.709028] Dynamic subtest C-eDP1: SUCCESS (8.819s)
[346.722321] Starting dynamic subtest: D-eDP1
[355.532078] Dynamic subtest D-eDP1: SUCCESS (8.823s)
[355.533112] Subtest plain-flip-ts-check-interruptible: SUCCESS (35.386s)
[356.675955] [079/130] (674s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-mmap-cpu)
[356.764509] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-mmap-cpu
[363.496799] Subtest psr-1p-offscreen-pri-shrfb-draw-mmap-cpu: SUCCESS (6.732s)
[363.608796] [080/130] (667s left) gem_exec_reloc (basic-cpu-gtt)
[363.662941] Subtest basic-cpu-gtt: SKIP (0.000s)
[363.733188] [081/130] (667s left) perf (invalid-open-flags)
[363.850110] Starting subtest: invalid-open-flags
[363.851024] Subtest invalid-open-flags: SUCCESS (0.000s)
[363.893768] [082/130] (667s left) syncobj_timeline (invalid-multi-wait-unsubmitted-signaled)
[363.939816] Starting subtest: invalid-multi-wait-unsubmitted-signaled
[363.940735] Subtest invalid-multi-wait-unsubmitted-signaled: SUCCESS (0.000s)
[364.034032] [083/130] (667s left) gem_mmap_offset (basic-uaf)
[364.083726] Starting subtest: basic-uaf
[364.084922] Subtest basic-uaf: SUCCESS (0.001s)
[364.178794] [084/130] (666s left) kms_addfb_basic (too-high)
[364.267673] Starting subtest: too-high
[364.268830] Subtest too-high: SUCCESS (0.001s)
[364.369465] [085/130] (666s left) i915_pciid
[364.507137] [086/130] (666s left) vgem_basic (dmabuf-fence)
[364.539417] Starting subtest: dmabuf-fence
[364.540260] Subtest dmabuf-fence: SUCCESS (0.000s)
[364.595128] [087/130] (666s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-fullscreen)
[364.679703] Starting subtest: psr-2p-scndscrn-spr-indfb-fullscreen
[364.681660] Subtest psr-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s)
[364.794540] [088/130] (666s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-cpu)
[364.880936] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-cpu
[364.882784] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[364.986413] [089/130] (666s left) gen9_exec_parse (shadow-peek)
[365.029866] Subtest shadow-peek: SKIP (0.000s)
[365.088749] [090/130] (666s left) kms_flip (flip-vs-modeset-vs-hang)
[365.168787] Starting subtest: flip-vs-modeset-vs-hang
[365.169699] Starting dynamic subtest: A-eDP1
[415.969772] Dynamic subtest A-eDP1: SUCCESS (50.787s)
[415.979767] Starting dynamic subtest: D-eDP1
[454.877072] Dynamic subtest D-eDP1: SUCCESS (38.893s)
[454.878495] Subtest flip-vs-modeset-vs-hang: SUCCESS (89.686s)
[455.273436] [091/130] (576s left) kms_atomic (plane-immutable-zpos)
[455.357699] Starting subtest: plane-immutable-zpos
[455.358565] Starting dynamic subtest: pipe-A-eDP-1
[456.017872] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.659s)
[456.019160] Subtest plane-immutable-zpos: SUCCESS (0.660s)
[456.806222] [092/130] (574s left) kms_ccs (crc-primary-rotation-180-y-tiled-ccs)
[456.903874] Starting subtest: crc-primary-rotation-180-y-tiled-ccs
[456.904756] Starting dynamic subtest: pipe-A-eDP-1
[456.913485] Dynamic subtest pipe-A-eDP-1: SKIP (0.001s)
[456.922548] Starting dynamic subtest: pipe-B-eDP-1
[456.931335] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[456.940315] Starting dynamic subtest: pipe-C-eDP-1
[456.948582] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[456.957103] Starting dynamic subtest: pipe-D-eDP-1
[456.965273] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[456.967026] Subtest crc-primary-rotation-180-y-tiled-ccs: SKIP (0.007s)
[459.167262] [093/130] (572s left) gem_ccs (ctrl-surf-copy)
[459.216422] Starting subtest: ctrl-surf-copy
[459.218371] Subtest ctrl-surf-copy: SKIP (0.000s)
[459.307370] [094/130] (572s left) gem_ctx_persistence (legacy-engines-queued)
[459.371928] Starting subtest: legacy-engines-queued
[459.373041] Starting dynamic subtest: render
[459.436822] Dynamic subtest render: SUCCESS (0.064s)
[459.448872] Starting dynamic subtest: bsd1
[461.416458] Dynamic subtest bsd1: SUCCESS (1.969s)
[461.428252] Starting dynamic subtest: bsd2
[463.399798] Dynamic subtest bsd2: SUCCESS (1.980s)
[463.408784] Starting dynamic subtest: blt
[463.446276] Dynamic subtest blt: SUCCESS (0.052s)
[463.458449] Starting dynamic subtest: vebox
[465.384675] Dynamic subtest vebox: SUCCESS (1.928s)
[465.385989] Subtest legacy-engines-queued: SUCCESS (6.006s)
[465.451018] [095/130] (566s left) kms_psr2_sf (pr-plane-move-sf-dmg-area)
[465.551616] Starting subtest: pr-plane-move-sf-dmg-area
[465.553532] Subtest pr-plane-move-sf-dmg-area: SKIP (0.000s)
[465.619781] [096/130] (565s left) kms_big_fb (4-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip)
[465.717959] Starting subtest: 4-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip
[466.387685] Subtest 4-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SUCCESS (0.670s)
[466.544740] [097/130] (565s left) kms_cursor_legacy (flip-vs-cursor-crc-atomic)
[466.656777] Starting subtest: flip-vs-cursor-crc-atomic
[467.362041] Subtest flip-vs-cursor-crc-atomic: SUCCESS (0.704s)
[468.195137] [098/130] (563s left) syncobj_timeline (multi-wait-for-submit-unsubmitted-submitted-signaled)
[468.238801] Starting subtest: multi-wait-for-submit-unsubmitted-submitted-signaled
[468.239599] Subtest multi-wait-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[468.327339] [099/130] (563s left) kms_addfb_basic (bad-pitch-63)
[468.390724] Starting subtest: bad-pitch-63
[468.391857] Subtest bad-pitch-63: SUCCESS (0.000s)
[468.522205] [100/130] (563s left) kms_draw_crc (draw-method-render)
[468.615606] Starting subtest: draw-method-render
[468.616756] Starting dynamic subtest: xrgb8888-untiled
[468.872734] Dynamic subtest xrgb8888-untiled: SUCCESS (0.256s)
[468.881426] Starting dynamic subtest: rgb565-untiled
[469.094900] Dynamic subtest rgb565-untiled: SUCCESS (0.221s)
[469.103954] Starting dynamic subtest: xrgb2101010-untiled
[469.328176] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.233s)
[469.342478] Starting dynamic subtest: xbgr16161616f-untiled
[469.583905] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.255s)
[469.592908] Starting dynamic subtest: xrgb8888-xtiled
[469.717040] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.133s)
[469.728945] Starting dynamic subtest: rgb565-xtiled
[469.839090] Dynamic subtest rgb565-xtiled: SUCCESS (0.121s)
[469.848057] Starting dynamic subtest: xrgb2101010-xtiled
[469.961544] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.121s)
[469.971808] Starting dynamic subtest: xbgr16161616f-xtiled
[470.095041] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.131s)
[470.104308] Starting dynamic subtest: xrgb8888-4tiled
[470.228186] Dynamic subtest xrgb8888-4tiled: SUCCESS (0.132s)
[470.238580] Starting dynamic subtest: rgb565-4tiled
[470.350926] Dynamic subtest rgb565-4tiled: SUCCESS (0.120s)
[470.368903] Starting dynamic subtest: xrgb2101010-4tiled
[470.472559] Dynamic subtest xrgb2101010-4tiled: SUCCESS (0.119s)
[470.481750] Starting dynamic subtest: xbgr16161616f-4tiled
[470.605601] Dynamic subtest xbgr16161616f-4tiled: SUCCESS (0.132s)
[470.607698] Subtest draw-method-render: SUCCESS (1.992s)
[470.716648] [101/130] (561s left) kms_chamelium_edid (dp-mode-timings)
[471.099965] Subtest dp-mode-timings: SKIP (0.000s)
[471.904550] [102/130] (559s left) device_reset (unbind-cold-reset-rebind)
[471.953022] Starting subtest: unbind-cold-reset-rebind
[471.954855] Subtest unbind-cold-reset-rebind: SKIP (0.000s)
[472.013103] [103/130] (559s left) kms_psr2_su (frontbuffer-xrgb8888)
[472.064162] Subtest frontbuffer-XRGB8888: SKIP (0.000s)
[472.116193] [104/130] (559s left) perf_pmu (semaphore-wait)
[472.151563] Starting subtest: semaphore-wait
[472.152782] Starting dynamic subtest: rcs0
[472.675173] Dynamic subtest rcs0: SUCCESS (0.513s)
[472.684934] Starting dynamic subtest: bcs0
[473.189605] Dynamic subtest bcs0: SUCCESS (0.510s)
[473.199525] Starting dynamic subtest: vcs0
[473.702873] Dynamic subtest vcs0: SUCCESS (0.510s)
[473.713067] Starting dynamic subtest: vcs1
[474.215582] Dynamic subtest vcs1: SUCCESS (0.510s)
[474.225667] Starting dynamic subtest: vecs0
[474.729311] Dynamic subtest vecs0: SUCCESS (0.511s)
[474.740335] Starting dynamic subtest: ccs0
[475.245410] Dynamic subtest ccs0: SUCCESS (0.513s)
[475.246690] Subtest semaphore-wait: SUCCESS (3.086s)
[476.422172] [105/130] (555s left) syncobj_basic (test-valid-cycle)
[476.470290] Starting subtest: test-valid-cycle
[476.471304] Subtest test-valid-cycle: SUCCESS (0.000s)
[476.570273] [106/130] (555s left) syncobj_timeline (etime-multi-wait-all-for-submit-unsubmitted)
[476.614407] Starting subtest: etime-multi-wait-all-for-submit-unsubmitted
[476.716590] Subtest etime-multi-wait-all-for-submit-unsubmitted: SUCCESS (0.101s)
[476.792626] [107/130] (555s left) kms_lease (implicit-plane-lease)
[476.883927] Starting subtest: implicit-plane-lease
[476.887135] Subtest implicit-plane-lease: SUCCESS (0.003s)
[476.985051] [108/130] (554s left) api_intel_allocator (simple-allocator)
[477.034321] Starting subtest: simple-allocator
[477.035300] Starting dynamic subtest: basic
[477.038158] Dynamic subtest basic: SUCCESS (0.004s)
[477.049081] Starting dynamic subtest: parallel-one
[477.226642] Dynamic subtest parallel-one: SUCCESS (0.179s)
[477.235669] Starting dynamic subtest: print
[477.236605] Dynamic subtest print: SUCCESS (0.000s)
[477.245870] Starting dynamic subtest: reuse
[477.246746] Dynamic subtest reuse: SUCCESS (0.000s)
[477.255362] Starting dynamic subtest: reserve
[477.256266] Dynamic subtest reserve: SUCCESS (0.000s)
[477.264796] Starting dynamic subtest: fork-reopen-allocator
[477.265718] Dynamic subtest fork-reopen-allocator: SUCCESS (0.011s)
[477.266625] Subtest simple-allocator: SUCCESS (0.198s)
[477.336559] [109/130] (554s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-render)
[477.428773] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-render
[477.430655] Subtest fbc-2p-primscrn-spr-indfb-draw-render: SKIP (0.000s)
[477.525102] [110/130] (554s left) kms_panel_fitting (legacy)
[477.613063] Starting subtest: legacy
[477.613991] Starting dynamic subtest: pipe-A-eDP-1
[478.180509] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.567s)
[478.209228] Starting dynamic subtest: pipe-B-eDP-1
[479.809576] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.610s)
[479.837382] Starting dynamic subtest: pipe-C-eDP-1
[481.411705] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.584s)
[481.439938] Starting dynamic subtest: pipe-D-eDP-1
[482.948380] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.518s)
[482.949487] Subtest legacy: SUCCESS (5.337s)
[484.159219] [111/130] (547s left) gem_wait (write-busy)
[484.222346] Starting subtest: write-busy
[484.223235] Starting dynamic subtest: all-engines
[484.845599] Dynamic subtest all-engines: SUCCESS (0.623s)
[484.863935] Starting dynamic subtest: rcs0
[485.417092] Dynamic subtest rcs0: SUCCESS (0.560s)
[485.428545] Starting dynamic subtest: bcs0
[485.955874] Dynamic subtest bcs0: SUCCESS (0.548s)
[485.970551] Starting dynamic subtest: vcs0
[487.438889] Dynamic subtest vcs0: SUCCESS (1.466s)
[487.448355] Starting dynamic subtest: vcs1
[489.422092] Dynamic subtest vcs1: SUCCESS (1.981s)
[489.431806] Starting dynamic subtest: vecs0
[491.404877] Dynamic subtest vecs0: SUCCESS (1.981s)
[491.415350] Starting dynamic subtest: ccs0
[491.941729] Dynamic subtest ccs0: SUCCESS (0.549s)
[491.943251] Subtest write-busy: SUCCESS (7.722s)
[492.148467] [112/130] (539s left) kms_cursor_legacy (single-bo)
[492.272574] Starting subtest: single-bo
[492.273534] Starting dynamic subtest: pipe-A
[497.699163] Dynamic subtest pipe-A: SUCCESS (5.380s)
[497.711317] Starting dynamic subtest: pipe-B
[503.081762] Dynamic subtest pipe-B: SUCCESS (5.380s)
[503.093290] Starting dynamic subtest: pipe-C
[508.462887] Dynamic subtest pipe-C: SUCCESS (5.379s)
[508.474233] Starting dynamic subtest: pipe-D
[513.845127] Dynamic subtest pipe-D: SUCCESS (5.379s)
[513.856610] Starting dynamic subtest: all-pipes
[519.234007] Dynamic subtest all-pipes: SUCCESS (5.387s)
[519.235033] Subtest single-bo: SUCCESS (26.918s)
[519.332000] [113/130] (512s left) kms_ccs (missing-ccs-buffer-4-tiled-mtl-mc-ccs)
[519.421083] Starting subtest: missing-ccs-buffer-4-tiled-mtl-mc-ccs
[519.421877] Starting dynamic subtest: pipe-A-eDP-1
[519.442109] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.021s)
[519.452751] Starting dynamic subtest: pipe-B-eDP-1
[519.463784] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.020s)
[519.474572] Starting dynamic subtest: pipe-C-eDP-1
[519.486206] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.021s)
[519.496504] Starting dynamic subtest: pipe-D-eDP-1
[519.509298] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.022s)
[519.510088] Subtest missing-ccs-buffer-4-tiled-mtl-mc-ccs: SUCCESS (0.089s)
[521.833374] [114/130] (510s left) i915_pm_rpm (reg-read-ioctl)
[523.586185] Starting subtest: reg-read-ioctl
[525.878313] Subtest reg-read-ioctl: SUCCESS (2.295s)
[526.249070] [115/130] (505s left) kms_psr (fbc-psr2-primary-render)
[526.329404] Starting subtest: fbc-psr2-primary-render
[526.330360] Starting dynamic subtest: eDP-1
[526.332154] Dynamic subtest eDP-1: SKIP (0.000s)
[526.333710] Subtest fbc-psr2-primary-render: SKIP (0.001s)
[526.412696] [116/130] (505s left) kms_plane_scaling (plane-downscale-factor-0-5-with-rotation)
[526.496917] Starting subtest: plane-downscale-factor-0-5-with-rotation
[526.497778] Starting dynamic subtest: pipe-A
[526.517241] Dynamic subtest pipe-A: SKIP (0.017s)
[526.526446] Starting dynamic subtest: pipe-B
[526.549351] Dynamic subtest pipe-B: SKIP (0.032s)
[526.558171] Starting dynamic subtest: pipe-C
[526.582260] Dynamic subtest pipe-C: SKIP (0.032s)
[526.591056] Starting dynamic subtest: pipe-D
[526.615583] Dynamic subtest pipe-D: SKIP (0.032s)
[526.617158] Subtest plane-downscale-factor-0-5-with-rotation: SKIP (0.117s)
[526.702637] [117/130] (505s left) kms_ccs (random-ccs-data-yf-tiled-ccs)
[526.792934] Starting subtest: random-ccs-data-yf-tiled-ccs
[526.794065] Starting dynamic subtest: pipe-A-eDP-1
[526.804217] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[526.814100] Starting dynamic subtest: pipe-B-eDP-1
[526.823482] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[526.832539] Starting dynamic subtest: pipe-C-eDP-1
[526.841158] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[526.849923] Starting dynamic subtest: pipe-D-eDP-1
[526.859112] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[526.860761] Subtest random-ccs-data-yf-tiled-ccs: SKIP (0.005s)
[529.119858] [118/130] (503s left) kms_hdmi_inject (inject-4k)
[529.476132] Starting subtest: inject-4k
[529.794092] Subtest inject-4k: SUCCESS (0.318s)
[530.318723] [119/130] (502s left) kms_color (degamma)
[530.409984] Starting subtest: degamma
[530.410833] Starting dynamic subtest: pipe-A-eDP-1
[531.131267] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.721s)
[531.140723] Starting dynamic subtest: pipe-B-eDP-1
[532.553591] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.422s)
[532.563693] Starting dynamic subtest: pipe-C-eDP-1
[533.900762] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.345s)
[533.910080] Starting dynamic subtest: pipe-D-eDP-1
[535.300569] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.399s)
[535.301498] Subtest degamma: SUCCESS (4.890s)
[536.147141] [120/130] (496s left) kms_cursor_crc (cursor-offscreen-128x42)
[536.365158] Starting subtest: cursor-offscreen-128x42
[536.413302] Subtest cursor-offscreen-128x42: SKIP (0.045s)
[536.628549] [121/130] (495s left) gem_fence_thrash (bo-copy)
[536.657832] Starting subtest: bo-copy
[536.670682] Subtest bo-copy: SKIP (0.013s)
[536.732353] [122/130] (495s left) perf_pmu (busy-accuracy-2)
[536.769164] Starting subtest: busy-accuracy-2
[536.770119] Starting dynamic subtest: rcs0
[539.818707] Dynamic subtest rcs0: SUCCESS (3.041s)
[539.828745] Starting dynamic subtest: bcs0
[542.876529] Dynamic subtest bcs0: SUCCESS (3.055s)
[542.888805] Starting dynamic subtest: vcs0
[545.924501] Dynamic subtest vcs0: SUCCESS (3.046s)
[545.933917] Starting dynamic subtest: vcs1
[548.973011] Dynamic subtest vcs1: SUCCESS (3.045s)
[548.987629] Starting dynamic subtest: vecs0
[552.016601] Dynamic subtest vecs0: SUCCESS (3.042s)
[552.025573] Starting dynamic subtest: ccs0
[555.075556] Dynamic subtest ccs0: SUCCESS (3.054s)
[555.076621] Subtest busy-accuracy-2: SUCCESS (18.298s)
[555.186768] [123/130] (477s left) gem_exec_balancer (bonded-false-hang)
[555.457516] Starting subtest: bonded-false-hang
[555.459411] Subtest bonded-false-hang: SKIP (0.000s)
[555.550654] [124/130] (477s left) kms_async_flips (async-flip-with-page-flip-events-linear-atomic)
[555.635864] Starting subtest: async-flip-with-page-flip-events-linear-atomic
[556.012223] Starting dynamic subtest: pipe-A-eDP-1
[558.810909] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.789s)
[559.166883] Starting dynamic subtest: pipe-B-eDP-1
[561.919243] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.751s)
[562.280969] Starting dynamic subtest: pipe-C-eDP-1
[565.017303] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.735s)
[565.381653] Starting dynamic subtest: pipe-D-eDP-1
[568.110502] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.727s)
[568.111770] Subtest async-flip-with-page-flip-events-linear-atomic: SUCCESS (12.464s)
[569.258258] [125/130] (463s left) gem_mmap_gtt (basic-wc)
[569.307888] Subtest basic-wc: SKIP (0.000s)
[569.363283] [126/130] (463s left) syncobj_wait (multi-wait-for-submit-unsubmitted-submitted-signaled)
[569.415039] Starting subtest: multi-wait-for-submit-unsubmitted-submitted-signaled
[569.416044] Subtest multi-wait-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[569.500295] [127/130] (463s left) gem_tiled_partial_pwrite_pread (writes-after-reads)
[569.544598] Subtest writes-after-reads: SKIP (0.000s)
[569.604706] [128/130] (463s left) gem_exec_gttfill (all-engines)
[569.663068] Starting subtest: all-engines
[592.830435] Subtest all-engines: SUCCESS (23.155s)
[593.014049] [129/130] (439s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-render)
[593.159451] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-render
[600.157158] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-render: SUCCESS (6.996s)
[600.305923] [130/130] (432s left) kms_sequence (get-forked)
[600.395269] Starting subtest: get-forked
[600.396241] Starting dynamic subtest: pipe-A-eDP-1
[602.278331] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.883s)
[602.289491] Starting dynamic subtest: pipe-B-eDP-1
[604.808911] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.528s)
[604.818526] Starting dynamic subtest: pipe-C-eDP-1
[607.352172] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.541s)
[607.362831] Starting dynamic subtest: pipe-D-eDP-1
[609.860532] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.506s)
[609.861429] Subtest get-forked: SUCCESS (9.464s)
[610.661631] Closing watchdogs
results: parsing output: 0/ for test: kms_frontbuffer_tracking
results: parsing output: 1/ for test: gem_workarounds
results: parsing output: 2/ for test: gem_render_copy
results: parsing output: 3/ for test: kms_frontbuffer_tracking
results: parsing output: 4/ for test: sw_sync
results: parsing output: 5/ for test: kms_frontbuffer_tracking
results: parsing output: 6/ for test: i915_suspend
results: parsing output: 7/ for test: kms_cursor_crc
results: parsing output: 8/ for test: kms_big_fb
results: parsing output: 9/ for test: kms_flip_scaled_crc
results: parsing output: 10/ for test: gem_userptr_blits
results: parsing output: 11/ for test: gem_pxp
results: parsing output: 12/ for test: kms_frontbuffer_tracking
results: parsing output: 13/ for test: kms_big_fb
results: parsing output: 14/ for test: kms_frontbuffer_tracking
results: parsing output: 15/ for test: kms_ccs
results: parsing output: 16/ for test: gem_exec_params
results: parsing output: 17/ for test: kms_psr
results: parsing output: 18/ for test: kms_getfb
results: parsing output: 19/ for test: kms_pipe_stress
results: parsing output: 20/ for test: kms_psr
results: parsing output: 21/ for test: gem_flink_basic
results: parsing output: 22/ for test: kms_vblank
results: parsing output: 23/ for test: kms_cursor_legacy
results: parsing output: 24/ for test: kms_flip
results: parsing output: 25/ for test: kms_psr
results: parsing output: 26/ for test: kms_addfb_basic
results: parsing output: 27/ for test: gem_exec_schedule
results: parsing output: 28/ for test: kms_frontbuffer_tracking
results: parsing output: 29/ for test: kms_psr
results: parsing output: 30/ for test: gem_lmem_swapping
results: parsing output: 31/ for test: kms_frontbuffer_tracking
results: parsing output: 32/ for test: kms_flip
results: parsing output: 33/ for test: kms_psr2_sf
results: parsing output: 34/ for test: kms_frontbuffer_tracking
results: parsing output: 35/ for test: gem_exec_store
results: parsing output: 36/ for test: kms_chamelium_hpd
results: parsing output: 37/ for test: kms_big_fb
results: parsing output: 38/ for test: gem_softpin
results: parsing output: 39/ for test: perf_pmu
results: parsing output: 40/ for test: gem_ctx_param
results: parsing output: 41/ for test: kms_ccs
results: parsing output: 42/ for test: prime_self_import
results: parsing output: 43/ for test: kms_content_protection
results: parsing output: 44/ for test: kms_plane
results: parsing output: 45/ for test: syncobj_timeline
results: parsing output: 46/ for test: kms_big_fb
results: parsing output: 47/ for test: kms_plane_lowres
results: parsing output: 48/ for test: kms_big_fb
results: parsing output: 49/ for test: gem_mmap_gtt
results: parsing output: 50/ for test: gem_mmap_wc
results: parsing output: 51/ for test: api_intel_bb
results: parsing output: 52/ for test: kms_plane_scaling
results: parsing output: 53/ for test: gem_render_copy_redux
results: parsing output: 54/ for test: kms_frontbuffer_tracking
results: parsing output: 55/ for test: kms_flip
results: parsing output: 56/ for test: gem_spin_batch
results: parsing output: 57/ for test: gem_exec_basic
results: parsing output: 58/ for test: kms_pm_dc
results: parsing output: 59/ for test: gem_exec_schedule
results: parsing output: 60/ for test: vgem_basic
results: parsing output: 61/ for test: gem_userptr_blits
results: parsing output: 62/ for test: kms_frontbuffer_tracking
results: parsing output: 63/ for test: kms_cursor_crc
results: parsing output: 64/ for test: gem_exec_fence
results: parsing output: 65/ for test: kms_frontbuffer_tracking
results: parsing output: 66/ for test: kms_frontbuffer_tracking
results: parsing output: 67/ for test: gem_lmem_swapping
results: parsing output: 68/ for test: syncobj_timeline
results: parsing output: 69/ for test: gem_exec_params
results: parsing output: 70/ for test: kms_flip
results: parsing output: 71/ for test: i915_drm_fdinfo
results: parsing output: 72/ for test: kms_big_fb
results: parsing output: 73/ for test: gem_eio
results: parsing output: 74/ for test: gem_close_race
results: parsing output: 75/ for test: kms_frontbuffer_tracking
results: parsing output: 76/ for test: kms_invalid_mode
results: parsing output: 77/ for test: kms_flip
results: parsing output: 78/ for test: kms_frontbuffer_tracking
results: parsing output: 79/ for test: gem_exec_reloc
results: parsing output: 80/ for test: perf
results: parsing output: 81/ for test: syncobj_timeline
results: parsing output: 82/ for test: gem_mmap_offset
results: parsing output: 83/ for test: kms_addfb_basic
results: parsing output: 84/ for test: i915_pciid
results: parsing output: 85/ for test: vgem_basic
results: parsing output: 86/ for test: kms_frontbuffer_tracking
results: parsing output: 87/ for test: kms_frontbuffer_tracking
results: parsing output: 88/ for test: gen9_exec_parse
results: parsing output: 89/ for test: kms_flip
results: parsing output: 90/ for test: kms_atomic
results: parsing output: 91/ for test: kms_ccs
results: parsing output: 92/ for test: gem_ccs
results: parsing output: 93/ for test: gem_ctx_persistence
results: parsing output: 94/ for test: kms_psr2_sf
results: parsing output: 95/ for test: kms_big_fb
results: parsing output: 96/ for test: kms_cursor_legacy
results: parsing output: 97/ for test: syncobj_timeline
results: parsing output: 98/ for test: kms_addfb_basic
results: parsing output: 99/ for test: kms_draw_crc
results: parsing output: 100/ for test: kms_chamelium_edid
results: parsing output: 101/ for test: device_reset
results: parsing output: 102/ for test: kms_psr2_su
results: parsing output: 103/ for test: perf_pmu
results: parsing output: 104/ for test: syncobj_basic
results: parsing output: 105/ for test: syncobj_timeline
results: parsing output: 106/ for test: kms_lease
results: parsing output: 107/ for test: api_intel_allocator
results: parsing output: 108/ for test: kms_frontbuffer_tracking
results: parsing output: 109/ for test: kms_panel_fitting
results: parsing output: 110/ for test: gem_wait
results: parsing output: 111/ for test: kms_cursor_legacy
results: parsing output: 112/ for test: kms_ccs
results: parsing output: 113/ for test: i915_pm_rpm
results: parsing output: 114/ for test: kms_psr
results: parsing output: 115/ for test: kms_plane_scaling
results: parsing output: 116/ for test: kms_ccs
results: parsing output: 117/ for test: kms_hdmi_inject
results: parsing output: 118/ for test: kms_color
results: parsing output: 119/ for test: kms_cursor_crc
results: parsing output: 120/ for test: gem_fence_thrash
results: parsing output: 121/ for test: perf_pmu
results: parsing output: 122/ for test: gem_exec_balancer
results: parsing output: 123/ for test: kms_async_flips
results: parsing output: 124/ for test: gem_mmap_gtt
results: parsing output: 125/ for test: syncobj_wait
results: parsing output: 126/ for test: gem_tiled_partial_pwrite_pread
results: parsing output: 127/ for test: gem_exec_gttfill
results: parsing output: 128/ for test: kms_frontbuffer_tracking
results: parsing output: 129/ for test: kms_sequence
Done.