[73.211920] Initializing watchdogs
[73.211989]   /dev/watchdog0
[73.232700] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:03:00.0: 8086:56a0 Intel Dg2 (Gen12) DG2 [Arc A770]
[73.243843] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card1
[73.248021] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[73.250578] [001/131] (960s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-msflip-blt)
[73.457529] Starting subtest: fbc-2p-primscrn-shrfb-msflip-blt
[73.459234] Subtest fbc-2p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[73.598186] [002/131] (960s left) kms_flip (2x-absolute-wf_vblank-interruptible)
[73.791425] Starting subtest: 2x-absolute-wf_vblank-interruptible
[73.806942] Subtest 2x-absolute-wf_vblank-interruptible: SKIP (0.014s)
[73.914363] [003/131] (959s left) kms_plane (plane-position-hole)
[74.102167] Starting subtest: plane-position-hole
[74.557992] Starting dynamic subtest: pipe-A-plane-1
[75.014267] Dynamic subtest pipe-A-plane-1: SUCCESS (0.453s)
[75.025965] Starting dynamic subtest: pipe-A-plane-2
[75.480323] Dynamic subtest pipe-A-plane-2: SUCCESS (0.464s)
[75.488516] Starting dynamic subtest: pipe-A-plane-3
[75.953047] Dynamic subtest pipe-A-plane-3: SUCCESS (0.470s)
[75.963383] Starting dynamic subtest: pipe-A-plane-4
[76.455357] Dynamic subtest pipe-A-plane-4: SUCCESS (0.500s)
[76.464655] Starting dynamic subtest: pipe-A-plane-5
[76.477430] Dynamic subtest pipe-A-plane-5: SUCCESS (0.021s)
[76.822490] Starting dynamic subtest: pipe-B-plane-1
[77.237299] Dynamic subtest pipe-B-plane-1: SUCCESS (0.422s)
[77.245599] Starting dynamic subtest: pipe-B-plane-2
[77.694286] Dynamic subtest pipe-B-plane-2: SUCCESS (0.455s)
[77.702133] Starting dynamic subtest: pipe-B-plane-3
[78.117203] Dynamic subtest pipe-B-plane-3: SUCCESS (0.422s)
[78.125349] Starting dynamic subtest: pipe-B-plane-4
[78.538409] Dynamic subtest pipe-B-plane-4: SUCCESS (0.419s)
[78.546406] Starting dynamic subtest: pipe-B-plane-5
[78.556887] Dynamic subtest pipe-B-plane-5: SUCCESS (0.018s)
[78.557745] Subtest plane-position-hole: SUCCESS (4.434s)
[78.797284] [004/131] (955s left) kms_flip (nonblocking-read)
[78.986040] Starting subtest: nonblocking-read
[78.986934] Subtest nonblocking-read: SUCCESS (0.000s)
[79.147728] [005/131] (954s left) gem_tiled_pread_basic
[79.306542] [006/131] (954s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-180)
[79.508275] Starting subtest: linear-max-hw-stride-32bpp-rotate-180
[80.871157] Subtest linear-max-hw-stride-32bpp-rotate-180: SUCCESS (1.359s)
[81.070947] [007/131] (953s left) kms_psr (fbc-psr-cursor-mmap-cpu)
[81.262082] Subtest fbc-psr-cursor-mmap-cpu: SKIP (0.000s)
[81.310752] [008/131] (952s left) kms_ccs (missing-ccs-buffer-y-tiled-ccs)
[81.499171] Starting subtest: missing-ccs-buffer-y-tiled-ccs
[81.500117] Starting dynamic subtest: pipe-A-DP-3
[81.508421] Dynamic subtest pipe-A-DP-3: SKIP (0.000s)
[81.516066] Starting dynamic subtest: pipe-B-DP-3
[81.524288] Dynamic subtest pipe-B-DP-3: SKIP (0.000s)
[81.531783] Starting dynamic subtest: pipe-C-DP-3
[81.540018] Dynamic subtest pipe-C-DP-3: SKIP (0.000s)
[81.547426] Starting dynamic subtest: pipe-D-DP-3
[81.556957] Dynamic subtest pipe-D-DP-3: SKIP (0.000s)
[81.559033] Subtest missing-ccs-buffer-y-tiled-ccs: SKIP (0.004s)
[81.978902] [009/131] (952s left) kms_getfb (getfb2-accept-nv12)
[82.165446] Starting subtest: getfb2-accept-nv12
[82.167411] Subtest getfb2-accept-nv12: SUCCESS (0.002s)
[82.324852] [010/131] (952s left) kms_pm_rpm (cursor-dpms)
[84.050291] Starting subtest: cursor-dpms
[84.053102] Subtest cursor-dpms: SKIP (0.000s)
[84.391353] [011/131] (950s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt)
[84.585684] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt
[84.587297] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[84.722589] [012/131] (949s left) kms_chamelium_hpd (hdmi-hpd-after-suspend)
[84.995785] Subtest hdmi-hpd-after-suspend: SKIP (0.000s)
[85.143506] [013/131] (949s left) gem_pread (self)
[85.223850] Subtest self: SKIP (0.000s)
[85.304373] [014/131] (949s left) gem_bad_reloc (negative-reloc-lut)
[85.387177] Subtest negative-reloc-lut: SKIP (0.000s)
[85.446805] [015/131] (949s left) sriov_basic (enable-vfs-autoprobe-on)
[85.528380] Subtest enable-vfs-autoprobe-on: SKIP (0.000s)
[85.617809] [016/131] (949s left) gem_ctx_param (invalid-get-ringsize)
[85.685366] Starting subtest: invalid-get-ringsize
[85.687232] Subtest invalid-get-ringsize: SUCCESS (0.001s)
[85.845259] [017/131] (948s left) syncobj_wait (multi-wait-all-for-submit-submitted)
[85.914151] Starting subtest: multi-wait-all-for-submit-submitted
[86.019600] Subtest multi-wait-all-for-submit-submitted: SUCCESS (0.104s)
[86.123295] [018/131] (948s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-move)
[86.315494] Starting subtest: psr-2p-scndscrn-cur-indfb-move
[86.317233] Subtest psr-2p-scndscrn-cur-indfb-move: SKIP (0.000s)
[86.444080] [019/131] (948s left) kms_flip (modeset-vs-vblank-race-interruptible)
[86.637579] Starting subtest: modeset-vs-vblank-race-interruptible
[86.642200] Starting dynamic subtest: A-DP3
[89.896344] Dynamic subtest A-DP3: SUCCESS (3.250s)
[89.933770] Starting dynamic subtest: B-DP3
[93.132683] Dynamic subtest B-DP3: SUCCESS (3.231s)
[93.171184] Starting dynamic subtest: C-DP3
[96.404376] Dynamic subtest C-DP3: SUCCESS (3.266s)
[96.439469] Starting dynamic subtest: D-DP3
[99.571393] Dynamic subtest D-DP3: SUCCESS (3.161s)
[99.580185] Subtest modeset-vs-vblank-race-interruptible: SUCCESS (12.932s)
[99.939416] [020/131] (935s left) kms_psr (fbc-psr-sprite-render)
[100.130097] Subtest fbc-psr-sprite-render: SKIP (0.000s)
[100.192363] [021/131] (934s left) gem_softpin (allocator-basic-reserve)
[100.270984] Starting subtest: allocator-basic-reserve
[100.506947] Subtest allocator-basic-reserve: SUCCESS (0.228s)
[100.664350] [022/131] (934s left) drm_read (invalid-buffer)
[100.919910] Starting subtest: invalid-buffer
[100.920853] Subtest invalid-buffer: SUCCESS (0.000s)
[101.153846] [023/131] (933s left) i915_drm_fdinfo (memory-info-shared)
[101.216775] Starting subtest: memory-info-shared
[101.217686] Starting dynamic subtest: lmem0
[101.295739] Dynamic subtest lmem0: SUCCESS (0.079s)
[101.304213] Starting dynamic subtest: smem0
[101.342767] Dynamic subtest smem0: SUCCESS (0.046s)
[101.343781] Subtest memory-info-shared: SUCCESS (0.126s)
[101.484986] [024/131] (933s left) i915_drm_fdinfo (busy-idle)
[101.547219] Starting subtest: busy-idle
[101.548164] Starting dynamic subtest: rcs0
[101.564338] Dynamic subtest rcs0: SKIP (0.016s)
[101.573066] Starting dynamic subtest: bcs0
[101.576237] Dynamic subtest bcs0: SKIP (0.010s)
[101.584801] Starting dynamic subtest: vcs0
[101.586531] Dynamic subtest vcs0: SKIP (0.000s)
[101.594488] Starting dynamic subtest: vcs1
[101.596540] Dynamic subtest vcs1: SKIP (0.000s)
[101.604643] Starting dynamic subtest: vecs0
[101.606887] Dynamic subtest vecs0: SKIP (0.000s)
[101.614885] Starting dynamic subtest: vecs1
[101.617204] Dynamic subtest vecs1: SKIP (0.000s)
[101.626240] Starting dynamic subtest: ccs0
[101.628593] Dynamic subtest ccs0: SKIP (0.000s)
[101.630874] Subtest busy-idle: SKIP (0.033s)
[101.671999] [025/131] (933s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-blt)
[101.864987] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-blt
[101.866833] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[101.984779] [026/131] (933s left) kms_psr (psr2-sprite-plane-onoff)
[102.175053] Subtest psr2-sprite-plane-onoff: SKIP (0.000s)
[102.226288] [027/131] (933s left) kms_ccs (ccs-on-another-bo-yf-tiled-ccs)
[102.415358] Starting subtest: ccs-on-another-bo-yf-tiled-ccs
[102.417622] Starting dynamic subtest: pipe-A-DP-3
[102.426173] Dynamic subtest pipe-A-DP-3: SKIP (0.000s)
[102.434176] Starting dynamic subtest: pipe-B-DP-3
[102.442436] Dynamic subtest pipe-B-DP-3: SKIP (0.000s)
[102.450249] Starting dynamic subtest: pipe-C-DP-3
[102.458488] Dynamic subtest pipe-C-DP-3: SKIP (0.000s)
[102.466229] Starting dynamic subtest: pipe-D-DP-3
[102.476759] Dynamic subtest pipe-D-DP-3: SKIP (0.000s)
[102.478466] Subtest ccs-on-another-bo-yf-tiled-ccs: SKIP (0.006s)
[102.863088] [028/131] (932s left) kms_dp_link_training (uhbr-sst)
[103.048460] Starting subtest: uhbr-sst
[103.050267] Subtest uhbr-sst: SKIP (0.000s)
[103.160094] [029/131] (932s left) kms_psr2_sf (fbc-psr2-overlay-primary-update-sf-dmg-area)
[103.349925] Subtest fbc-psr2-overlay-primary-update-sf-dmg-area: SKIP (0.000s)
[103.407797] [030/131] (932s left) perf (blocking-parameterized)
[103.765296] Starting subtest: blocking-parameterized
[123.798027] Subtest blocking-parameterized: SUCCESS (20.027s)
[123.848590] [031/131] (911s left) kms_cursor_legacy (cursora-vs-flipb-legacy)
[124.053264] Starting subtest: cursorA-vs-flipB-legacy
[124.055441] Subtest cursorA-vs-flipB-legacy: SKIP (0.002s)
[124.158780] [032/131] (911s left) kms_color (deep-color)
[124.344368] Starting subtest: deep-color
[127.678233] Starting dynamic subtest: pipe-A-DP-3-gamma
[133.585980] Dynamic subtest pipe-A-DP-3-gamma: SUCCESS (5.907s)
[133.595931] Starting dynamic subtest: pipe-A-DP-3-degamma
[139.434516] Dynamic subtest pipe-A-DP-3-degamma: SUCCESS (5.846s)
[139.444266] Starting dynamic subtest: pipe-A-DP-3-ctm
[145.284413] Dynamic subtest pipe-A-DP-3-ctm: SUCCESS (5.848s)
[148.541994] Starting dynamic subtest: pipe-B-DP-3-gamma
[154.348493] Dynamic subtest pipe-B-DP-3-gamma: SUCCESS (5.835s)
[154.363492] Starting dynamic subtest: pipe-B-DP-3-degamma
[160.197016] Dynamic subtest pipe-B-DP-3-degamma: SUCCESS (5.846s)
[160.207286] Starting dynamic subtest: pipe-B-DP-3-ctm
[166.049506] Dynamic subtest pipe-B-DP-3-ctm: SUCCESS (5.851s)
[169.337293] Starting dynamic subtest: pipe-C-DP-3-gamma
[175.181499] Dynamic subtest pipe-C-DP-3-gamma: SUCCESS (5.855s)
[175.190927] Starting dynamic subtest: pipe-C-DP-3-degamma
[181.018156] Dynamic subtest pipe-C-DP-3-degamma: SUCCESS (5.835s)
[181.026379] Starting dynamic subtest: pipe-C-DP-3-ctm
[186.858536] Dynamic subtest pipe-C-DP-3-ctm: SUCCESS (5.839s)
[190.051646] Starting dynamic subtest: pipe-D-DP-3-gamma
[195.877439] Dynamic subtest pipe-D-DP-3-gamma: SUCCESS (5.838s)
[195.887056] Starting dynamic subtest: pipe-D-DP-3-degamma
[201.705424] Dynamic subtest pipe-D-DP-3-degamma: SUCCESS (5.826s)
[201.717894] Starting dynamic subtest: pipe-D-DP-3-ctm
[207.520193] Dynamic subtest pipe-D-DP-3-ctm: SUCCESS (5.814s)
[207.521158] Subtest deep-color: SUCCESS (83.173s)
[207.764854] [033/131] (827s left) kms_pipe_b_c_ivb (disable-pipe-b-enable-pipe-c)
[207.837266] Subtest disable-pipe-B-enable-pipe-C: SKIP (0.000s)
[207.908936] [034/131] (827s left) kms_async_flips (async-flip-with-page-flip-events-linear)
[208.092742] Starting subtest: async-flip-with-page-flip-events-linear
[208.318076] Starting dynamic subtest: pipe-A-DP-3
[210.592982] Dynamic subtest pipe-A-DP-3: SUCCESS (2.274s)
[210.814903] Starting dynamic subtest: pipe-B-DP-3
[212.904402] Dynamic subtest pipe-B-DP-3: SUCCESS (2.097s)
[213.128176] Starting dynamic subtest: pipe-C-DP-3
[215.219312] Dynamic subtest pipe-C-DP-3: SUCCESS (2.098s)
[215.440525] Starting dynamic subtest: pipe-D-DP-3
[217.527550] Dynamic subtest pipe-D-DP-3: SUCCESS (2.094s)
[217.528892] Subtest async-flip-with-page-flip-events-linear: SUCCESS (9.435s)
[217.961945] [035/131] (817s left) kms_lease (lessee-list)
[218.155506] Starting subtest: lessee-list
[218.157970] Starting dynamic subtest: pipe-A-DP-3
[218.158895] Dynamic subtest pipe-A-DP-3: SUCCESS (0.002s)
[218.168438] Starting dynamic subtest: pipe-B-DP-3
[218.169321] Dynamic subtest pipe-B-DP-3: SUCCESS (0.002s)
[218.177382] Starting dynamic subtest: pipe-C-DP-3
[218.178305] Dynamic subtest pipe-C-DP-3: SUCCESS (0.002s)
[218.186634] Starting dynamic subtest: pipe-D-DP-3
[218.187778] Dynamic subtest pipe-D-DP-3: SUCCESS (0.002s)
[218.188776] Subtest lessee-list: SUCCESS (0.014s)
[218.290155] [036/131] (817s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-render)
[218.487163] Starting subtest: psr-1p-primscrn-cur-indfb-draw-render
[218.488898] Subtest psr-1p-primscrn-cur-indfb-draw-render: SKIP (0.000s)
[218.653991] [037/131] (817s left) sysfs_timeslice_duration (timeout)
[218.729955] Starting subtest: timeout
[218.730895] Starting dynamic subtest: vecs0
[220.515092] Dynamic subtest vecs0: SUCCESS (1.784s)
[220.523394] Starting dynamic subtest: ccs0
[222.295151] Dynamic subtest ccs0: SUCCESS (1.779s)
[222.303571] Starting dynamic subtest: vcs0
[223.980117] Dynamic subtest vcs0: SUCCESS (1.684s)
[223.988674] Starting dynamic subtest: bcs0
[225.074133] Dynamic subtest bcs0: SUCCESS (1.093s)
[225.082799] Starting dynamic subtest: vecs1
[226.772756] Dynamic subtest vecs1: SUCCESS (1.697s)
[226.788290] Starting dynamic subtest: rcs0
[228.466343] Dynamic subtest rcs0: SUCCESS (1.690s)
[228.475415] Starting dynamic subtest: vcs1
[230.141121] Dynamic subtest vcs1: SUCCESS (1.673s)
[230.142111] Subtest timeout: SUCCESS (11.411s)
[230.290901] [038/131] (805s left) gem_userptr_blits (create-destroy-unsync)
[230.369499] Subtest create-destroy-unsync: SKIP (0.000s)
[230.546604] [039/131] (805s left) gem_mmap_gtt (ptrace)
[230.618191] Subtest ptrace: SKIP (0.000s)
[230.691453] [040/131] (805s left) syncobj_wait (wait-all-for-submit-complex)
[230.762395] Starting subtest: wait-all-for-submit-complex
[230.981515] Subtest wait-all-for-submit-complex: SUCCESS (0.218s)
[231.105283] [041/131] (805s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-blt)
[231.298133] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-blt
[231.299866] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-blt: SKIP (0.000s)
[231.438973] [042/131] (804s left) gem_exec_fence (syncobj-timeline-wait)
[232.083406] Starting subtest: syncobj-timeline-wait
[232.214638] Subtest syncobj-timeline-wait: SUCCESS (0.132s)
[232.483252] [FACT gem_exec_fence (syncobj-timeline-wait)] new: kernel.kmod_is_loaded.vgem: true
[232.485415] [043/131] (803s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-shrfb-msflip-blt)
[232.685976] Starting subtest: fbcpsr-2p-scndscrn-shrfb-msflip-blt
[232.687785] Subtest fbcpsr-2p-scndscrn-shrfb-msflip-blt: SKIP (0.000s)
[232.820869] [044/131] (803s left) syncobj_timeline (transfer-timeline-point)
[232.899500] Starting subtest: transfer-timeline-point
[232.900402] Subtest transfer-timeline-point: SUCCESS (0.001s)
[233.049498] [045/131] (803s left) gem_spin_batch (legacy)
[233.137850] Starting subtest: legacy
[233.138777] Starting dynamic subtest: default
[236.403516] Dynamic subtest default: SUCCESS (3.261s)
[236.418170] Starting dynamic subtest: render
[239.638782] Dynamic subtest render: SUCCESS (3.230s)
[239.652339] Starting dynamic subtest: bsd
[242.875870] Dynamic subtest bsd: SUCCESS (3.231s)
[242.886814] Starting dynamic subtest: bsd1
[246.110129] Dynamic subtest bsd1: SUCCESS (3.230s)
[246.127549] Starting dynamic subtest: bsd2
[249.351790] Dynamic subtest bsd2: SUCCESS (3.235s)
[249.365564] Starting dynamic subtest: blt
[252.590231] Dynamic subtest blt: SUCCESS (3.232s)
[252.604534] Starting dynamic subtest: vebox
[255.828874] Dynamic subtest vebox: SUCCESS (3.232s)
[255.830693] Subtest legacy: SUCCESS (22.690s)
[256.073680] [046/131] (780s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-0-async-flip)
[256.283239] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-0-async-flip
[256.285160] Subtest y-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SKIP (0.000s)
[256.430015] [047/131] (780s left) api_intel_allocator (gem-pool)
[256.508712] Starting subtest: gem-pool
[256.541652] Subtest gem-pool: SUCCESS (0.034s)
[256.665923] [048/131] (780s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-render)
[256.873030] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-render
[256.874809] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-render: SKIP (0.000s)
[257.006730] [049/131] (779s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0-hflip)
[257.215546] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0-hflip
[258.452328] Subtest x-tiled-max-hw-stride-32bpp-rotate-0-hflip: SUCCESS (1.237s)
[258.681639] [050/131] (778s left) kms_frontbuffer_tracking (fbc-1p-offscren-pri-shrfb-draw-blt)
[258.892978] Starting subtest: fbc-1p-offscren-pri-shrfb-draw-blt
[261.190331] Subtest fbc-1p-offscren-pri-shrfb-draw-blt: SUCCESS (2.297s)
[261.403751] [051/131] (775s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-blt)
[261.607022] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-blt
[261.608768] Subtest psr-2p-primscrn-pri-shrfb-draw-blt: SKIP (0.000s)
[261.771499] [052/131] (775s left) kms_cursor_crc (cursor-sliding-512x512)
[262.242807] Starting subtest: cursor-sliding-512x512
[262.245831] Subtest cursor-sliding-512x512: SKIP (0.001s)
[262.489930] [053/131] (774s left) gem_request_retire (retire-vma-not-inactive)
[262.587760] Starting subtest: retire-vma-not-inactive
[262.670779] Subtest retire-vma-not-inactive: SUCCESS (0.083s)
[262.870488] [054/131] (774s left) gem_exec_schedule (noreorder)
[263.079298] Starting subtest: noreorder
[263.080217] Starting dynamic subtest: rcs0
[263.175510] Dynamic subtest rcs0: SUCCESS (0.101s)
[263.187142] Starting dynamic subtest: bcs0
[263.237644] Dynamic subtest bcs0: SUCCESS (0.060s)
[263.263570] Starting dynamic subtest: vcs0
[263.313900] Dynamic subtest vcs0: SUCCESS (0.074s)
[263.348905] Starting dynamic subtest: vcs1
[263.402584] Dynamic subtest vcs1: SUCCESS (0.086s)
[263.424443] Starting dynamic subtest: vecs0
[263.473084] Dynamic subtest vecs0: SUCCESS (0.068s)
[263.502065] Starting dynamic subtest: vecs1
[263.555776] Dynamic subtest vecs1: SUCCESS (0.079s)
[263.590685] Starting dynamic subtest: ccs0
[263.642386] Dynamic subtest ccs0: SUCCESS (0.084s)
[263.643372] Subtest noreorder: SUCCESS (0.569s)
[263.953242] [055/131] (773s left) gem_userptr_blits (coherency-sync)
[264.045014] Starting subtest: coherency-sync
[264.371239] Subtest coherency-sync: SKIP (0.309s)
[264.513498] [056/131] (772s left) kms_ccs (bad-pixel-format-4-tiled-mtl-rc-ccs)
[264.764498] Starting subtest: bad-pixel-format-4-tiled-mtl-rc-ccs
[264.767024] Starting dynamic subtest: pipe-A-DP-3
[264.775503] Dynamic subtest pipe-A-DP-3: SKIP (0.000s)
[264.784484] Starting dynamic subtest: pipe-B-DP-3
[264.792980] Dynamic subtest pipe-B-DP-3: SKIP (0.000s)
[264.801770] Starting dynamic subtest: pipe-C-DP-3
[264.809961] Dynamic subtest pipe-C-DP-3: SKIP (0.000s)
[264.818931] Starting dynamic subtest: pipe-D-DP-3
[264.829373] Dynamic subtest pipe-D-DP-3: SKIP (0.000s)
[264.831443] Subtest bad-pixel-format-4-tiled-mtl-rc-ccs: SKIP (0.007s)
[265.258212] [057/131] (772s left) kms_psr2_sf (psr2-cursor-plane-move-continuous-exceed-sf)
[265.467145] Subtest psr2-cursor-plane-move-continuous-exceed-sf: SKIP (0.000s)
[265.530588] [058/131] (771s left) kms_selftest (drm_dp_mst_helper)
[265.593990] Starting subtest: drm_dp_mst_helper
[265.613348] Starting dynamic subtest: drm_test_dp_mst_calc_pbn_mode
[265.700268] Dynamic subtest drm_test_dp_mst_calc_pbn_mode: SUCCESS (0.085s)
[265.725892] Starting dynamic subtest: drm_test_dp_mst_calc_pbn_div
[265.786291] Dynamic subtest drm_test_dp_mst_calc_pbn_div: SUCCESS (0.082s)
[265.812087] Starting dynamic subtest: drm_test_dp_mst_sideband_msg_req_decode
[265.899313] Dynamic subtest drm_test_dp_mst_sideband_msg_req_decode: SUCCESS (0.112s)
[265.905654] Subtest drm_dp_mst_helper: SUCCESS (0.307s)
[266.120868] [059/131] (771s left) kms_vblank (query-idle-hang)
[266.317510] Starting subtest: query-idle-hang
[266.319991] Starting dynamic subtest: pipe-A-DP-3
[292.548676] Dynamic subtest pipe-A-DP-3: SUCCESS (26.227s)
[292.559564] Starting dynamic subtest: pipe-D-DP-3
[317.538965] Dynamic subtest pipe-D-DP-3: SUCCESS (24.988s)
[317.539882] Subtest query-idle-hang: SUCCESS (51.221s)
[317.798744] [060/131] (719s left) kms_hdr (invalid-metadata-sizes)
[317.996545] Starting subtest: invalid-metadata-sizes
[321.340201] Starting dynamic subtest: pipe-A-DP-3
[321.341205] Dynamic subtest pipe-A-DP-3: SUCCESS (0.001s)
[321.342189] Subtest invalid-metadata-sizes: SUCCESS (3.345s)
[321.624188] [061/131] (716s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-render)
[321.827118] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-render
[321.828766] Subtest fbc-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s)
[321.964690] [062/131] (715s left) gem_exec_schedule (preempt-other)
[322.063275] Starting subtest: preempt-other
[322.064249] Starting dynamic subtest: rcs0
[322.437247] Dynamic subtest rcs0: SUCCESS (0.373s)
[322.446543] Starting dynamic subtest: bcs0
[322.784690] Dynamic subtest bcs0: SUCCESS (0.346s)
[322.794122] Starting dynamic subtest: vcs0
[323.133762] Dynamic subtest vcs0: SUCCESS (0.348s)
[323.143155] Starting dynamic subtest: vcs1
[323.479968] Dynamic subtest vcs1: SUCCESS (0.345s)
[323.489177] Starting dynamic subtest: vecs0
[323.828853] Dynamic subtest vecs0: SUCCESS (0.348s)
[323.838207] Starting dynamic subtest: vecs1
[324.196349] Dynamic subtest vecs1: SUCCESS (0.366s)
[324.205448] Starting dynamic subtest: ccs0
[324.543189] Dynamic subtest ccs0: SUCCESS (0.346s)
[324.544375] Subtest preempt-other: SUCCESS (2.480s)
[324.948695] [063/131] (712s left) tools_test (sysfs_l3_parity)
[325.003506] Starting subtest: sysfs_l3_parity
[325.072291] Subtest sysfs_l3_parity: SKIP (0.073s)
[325.154549] [064/131] (712s left) gem_tiled_partial_pwrite_pread (writes)
[325.241174] Subtest writes: SKIP (0.000s)
[325.296307] [065/131] (712s left) gem_userptr_blits (process-exit-busy)
[325.385660] Starting subtest: process-exit-busy
[325.401127] Subtest process-exit-busy: SUCCESS (0.015s)
[325.601576] [066/131] (712s left) gem_create (create-clear)
[325.682419] Starting subtest: create-clear
[325.683567] Starting dynamic subtest: lmem0
[359.617094] Dynamic subtest lmem0: SUCCESS (33.930s)
[359.631674] Starting dynamic subtest: smem0
[396.819335] Dynamic subtest smem0: SUCCESS (37.201s)
[396.820202] Subtest create-clear: SUCCESS (71.134s)
[397.018745] [067/131] (641s left) kms_big_fb (y-tiled-16bpp-rotate-270)
[397.223228] Starting subtest: y-tiled-16bpp-rotate-270
[397.224939] Subtest y-tiled-16bpp-rotate-270: SKIP (0.000s)
[397.356047] [068/131] (640s left) kms_frontbuffer_tracking (fbc-1p-primscrn-indfb-pgflip-blt)
[397.554044] Starting subtest: fbc-1p-primscrn-indfb-pgflip-blt
[400.358512] Subtest fbc-1p-primscrn-indfb-pgflip-blt: SUCCESS (2.804s)
[400.572637] [069/131] (637s left) gem_exec_params (dr4-dirt)
[400.660505] Starting subtest: DR4-dirt
[400.661448] Subtest DR4-dirt: SUCCESS (0.000s)
[400.799013] [070/131] (637s left) gem_exec_fence (keep-in-fence)
[401.002483] Starting subtest: keep-in-fence
[401.003426] Starting dynamic subtest: rcs0
[401.086811] Dynamic subtest rcs0: SUCCESS (0.084s)
[401.098634] Starting dynamic subtest: bcs0
[401.141713] Dynamic subtest bcs0: SUCCESS (0.054s)
[401.158421] Starting dynamic subtest: vcs0
[401.198344] Dynamic subtest vcs0: SUCCESS (0.055s)
[401.213012] Starting dynamic subtest: vcs1
[401.256667] Dynamic subtest vcs1: SUCCESS (0.056s)
[401.273107] Starting dynamic subtest: vecs0
[401.310836] Dynamic subtest vecs0: SUCCESS (0.053s)
[401.336029] Starting dynamic subtest: vecs1
[401.374803] Dynamic subtest vecs1: SUCCESS (0.061s)
[401.413066] Starting dynamic subtest: ccs0
[401.617347] Dynamic subtest ccs0: SUCCESS (0.239s)
[401.618441] Subtest keep-in-fence: SUCCESS (0.615s)
[402.341185] [071/131] (636s left) gem_eio (in-flight-10ms)
[402.612342] Starting subtest: in-flight-10ms
[407.586518] Subtest in-flight-10ms: SUCCESS (4.974s)
[407.824969] [072/131] (630s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-64bpp-ytile-upscaling)
[408.025587] Starting subtest: flip-32bpp-ytile-to-64bpp-ytile-upscaling
[408.028010] Starting dynamic subtest: pipe-A-valid-mode
[408.102560] Dynamic subtest pipe-A-valid-mode: SKIP (0.074s)
[408.104330] Subtest flip-32bpp-ytile-to-64bpp-ytile-upscaling: SKIP (0.076s)
[408.335366] [073/131] (630s left) kms_content_protection (content-type-change)
[408.599403] Starting subtest: content-type-change
[409.178134] Subtest content-type-change: SKIP (0.577s)
[409.557642] [074/131] (629s left) kms_fbcon_fbt (psr-suspend)
[409.638990] Starting subtest: psr-suspend
[409.640801] Subtest psr-suspend: SKIP (0.000s)
[409.819727] [075/131] (629s left) gem_exec_reloc (basic-wc-active)
[409.907053] Subtest basic-wc-active: SKIP (0.000s)
[410.014935] [076/131] (628s left) syncobj_wait (invalid-single-wait-unsubmitted)
[410.094272] Starting subtest: invalid-single-wait-unsubmitted
[410.095204] Subtest invalid-single-wait-unsubmitted: SUCCESS (0.000s)
[410.248122] [077/131] (628s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-mmap-cpu)
[410.446959] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-mmap-cpu
[410.448590] Subtest psr-2p-scndscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[410.580289] [078/131] (628s left) gem_ctx_persistence (legacy-engines-mixed)
[410.665461] Starting subtest: legacy-engines-mixed
[410.666402] Starting dynamic subtest: render
[410.777442] Dynamic subtest render: SUCCESS (0.111s)
[410.791169] Starting dynamic subtest: bsd1
[410.834495] Dynamic subtest bsd1: SUCCESS (0.055s)
[410.854012] Starting dynamic subtest: bsd2
[410.894130] Dynamic subtest bsd2: SUCCESS (0.057s)
[410.932911] Starting dynamic subtest: blt
[410.972399] Dynamic subtest blt: SUCCESS (0.073s)
[411.008293] Starting dynamic subtest: vebox
[411.050624] Dynamic subtest vebox: SUCCESS (0.073s)
[411.051712] Subtest legacy-engines-mixed: SUCCESS (0.386s)
[411.245552] [079/131] (627s left) kms_chamelium_edid (dp-edid-stress-resolution-4k)
[411.516088] Subtest dp-edid-stress-resolution-4k: SKIP (0.000s)
[411.693484] [080/131] (627s left) gem_userptr_blits (readonly-pwrite-unsync)
[411.780673] Subtest readonly-pwrite-unsync: SKIP (0.000s)
[411.978593] [081/131] (627s left) kms_flip (plain-flip-fb-recreate)
[412.181928] Starting subtest: plain-flip-fb-recreate
[412.186547] Starting dynamic subtest: A-DP3
[420.343201] Dynamic subtest A-DP3: SUCCESS (8.155s)
[420.357513] Starting dynamic subtest: B-DP3
[428.395390] Dynamic subtest B-DP3: SUCCESS (8.046s)
[428.432735] Starting dynamic subtest: C-DP3
[436.488624] Dynamic subtest C-DP3: SUCCESS (8.087s)
[436.529097] Starting dynamic subtest: D-DP3
[444.574713] Dynamic subtest D-DP3: SUCCESS (8.079s)
[444.584087] Subtest plain-flip-fb-recreate: SUCCESS (32.400s)
[444.969155] [082/131] (594s left) gem_pipe_control_store_loop (fresh-buffer)
[445.050660] Starting subtest: fresh-buffer
[447.231172] Subtest fresh-buffer: SUCCESS (2.180s)
[447.423044] [083/131] (592s left) gem_exec_alignment (pi)
[447.507784] Starting subtest: pi
[464.130987] Subtest pi: SUCCESS (16.621s)
[464.622031] [084/131] (574s left) kms_plane (pixel-format)
[464.865506] Starting subtest: pixel-format
[464.889770] Starting dynamic subtest: pipe-A-plane-0
[473.140433] Dynamic subtest pipe-A-plane-0: SUCCESS (8.250s)
[473.178591] Starting dynamic subtest: pipe-A-plane-3
[477.473610] Dynamic subtest pipe-A-plane-3: SUCCESS (4.331s)
[477.486523] Starting dynamic subtest: pipe-A-plane-5
[477.740601] Dynamic subtest pipe-A-plane-5: SUCCESS (0.266s)
[477.972794] Starting dynamic subtest: pipe-B-plane-0
[485.721951] Dynamic subtest pipe-B-plane-0: SUCCESS (7.766s)
[485.733377] Starting dynamic subtest: pipe-B-plane-3
[490.056315] Dynamic subtest pipe-B-plane-3: SUCCESS (4.333s)
[490.101067] Starting dynamic subtest: pipe-B-plane-5
[490.305838] Dynamic subtest pipe-B-plane-5: SUCCESS (0.246s)
[490.381753] Subtest pixel-format: SUCCESS (25.514s)
[490.655450] [085/131] (549s left) syncobj_wait (invalid-multi-wait-unsubmitted-signaled)
[490.740178] Starting subtest: invalid-multi-wait-unsubmitted-signaled
[490.741092] Subtest invalid-multi-wait-unsubmitted-signaled: SUCCESS (0.000s)
[490.855405] [086/131] (548s left) kms_flip (flip-vs-dpms-on-nop)
[491.055946] Starting subtest: flip-vs-dpms-on-nop
[491.057122] Starting dynamic subtest: A-DP3
[492.202948] Dynamic subtest A-DP3: SUCCESS (1.149s)
[492.219058] Starting dynamic subtest: B-DP3
[493.274668] Dynamic subtest B-DP3: SUCCESS (1.070s)
[493.286908] Starting dynamic subtest: C-DP3
[494.310193] Dynamic subtest C-DP3: SUCCESS (1.033s)
[494.350398] Starting dynamic subtest: D-DP3
[495.384989] Dynamic subtest D-DP3: SUCCESS (1.070s)
[495.387320] Subtest flip-vs-dpms-on-nop: SUCCESS (4.338s)
[495.724359] [087/131] (544s left) kms_vblank (ts-continuation-modeset-rpm)
[495.924480] Starting subtest: ts-continuation-modeset-rpm
[495.926975] Starting dynamic subtest: pipe-A-DP-3
[497.868461] Dynamic subtest pipe-A-DP-3: SUCCESS (1.942s)
[497.895117] Starting dynamic subtest: pipe-D-DP-3
[498.753327] Dynamic subtest pipe-D-DP-3: SUCCESS (0.877s)
[498.754200] Subtest ts-continuation-modeset-rpm: SUCCESS (2.829s)
[498.990263] [088/131] (540s left) syncobj_timeline (etime-multi-wait-for-submit-unsubmitted-submitted)
[499.075265] Starting subtest: etime-multi-wait-for-submit-unsubmitted-submitted
[499.178563] Subtest etime-multi-wait-for-submit-unsubmitted-submitted: SUCCESS (0.103s)
[499.325112] [089/131] (540s left) kms_pm_rpm (universal-planes-dpms)
[500.944630] Starting subtest: universal-planes-dpms
[500.951133] Starting dynamic subtest: plane-33
[503.812421] Dynamic subtest plane-33: SUCCESS (2.865s)
[503.860552] Starting dynamic subtest: plane-43
[506.681061] Dynamic subtest plane-43: SUCCESS (2.862s)
[506.729288] Starting dynamic subtest: plane-53
[509.599542] Dynamic subtest plane-53: SUCCESS (2.913s)
[509.648622] Starting dynamic subtest: plane-63
[512.584398] Dynamic subtest plane-63: SUCCESS (2.979s)
[512.630634] Starting dynamic subtest: plane-73
[515.457800] Dynamic subtest plane-73: SUCCESS (2.867s)
[515.506829] Starting dynamic subtest: plane-83
[518.355126] Dynamic subtest plane-83: SUCCESS (2.892s)
[518.359579] Subtest universal-planes-dpms: SUCCESS (17.413s)
[518.769078] [090/131] (521s left) kms_atomic_transition (modeset-transition-nonblocking)
[518.967468] Starting subtest: modeset-transition-nonblocking
[518.968373] Starting dynamic subtest: 1x-outputs
[521.530057] Dynamic subtest 1x-outputs: SUCCESS (2.562s)
[521.585115] Subtest modeset-transition-nonblocking: SUCCESS (2.618s)
[521.819919] [091/131] (518s left) kms_cursor_crc (cursor-offscreen-max-size)
[522.344185] Starting subtest: cursor-offscreen-max-size
[522.346876] Subtest cursor-offscreen-max-size: SKIP (0.000s)
[522.523018] [092/131] (517s left) gem_exec_balancer (smoke)
[522.613510] Starting subtest: smoke
[545.786476] Subtest smoke: SUCCESS (23.171s)
[546.447855] [093/131] (493s left) gem_userptr_blits (map-fixed-invalidate-overlap)
[546.546473] Starting subtest: map-fixed-invalidate-overlap
[546.548286] Subtest map-fixed-invalidate-overlap: SKIP (0.000s)
[546.736916] [094/131] (493s left) i915_pm_rpm (sysfs-read)
[549.064798] Starting subtest: sysfs-read
[549.457660] Subtest sysfs-read: SUCCESS (0.391s)
[549.855542] [095/131] (490s left) syncobj_timeline (etime-multi-wait-all-for-submit-available-unsubmitted)
[549.934505] Starting subtest: etime-multi-wait-all-for-submit-available-unsubmitted
[550.044612] Subtest etime-multi-wait-all-for-submit-available-unsubmitted: SUCCESS (0.108s)
[550.190282] [096/131] (490s left) syncobj_timeline (multi-wait-for-submit-available-signaled)
[550.268288] Starting subtest: multi-wait-for-submit-available-signaled
[550.269435] Subtest multi-wait-for-submit-available-signaled: SUCCESS (0.000s)
[550.446832] [097/131] (490s left) kms_addfb_basic (addfb25-y-tiled-small-legacy)
[550.641154] Starting subtest: addfb25-y-tiled-small-legacy
[550.642869] Subtest addfb25-y-tiled-small-legacy: SKIP (0.000s)
[550.809055] [098/131] (489s left) gem_exec_whisper (basic-forked)
[550.897380] Starting subtest: basic-forked
[557.924457] Subtest basic-forked: SUCCESS (7.026s)
[558.193842] [099/131] (482s left) kms_ccs (missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc)
[558.392540] Starting subtest: missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc
[558.395157] Starting dynamic subtest: pipe-A-DP-3
[558.403504] Dynamic subtest pipe-A-DP-3: SKIP (0.000s)
[558.414043] Starting dynamic subtest: pipe-B-DP-3
[558.422759] Dynamic subtest pipe-B-DP-3: SKIP (0.000s)
[558.433188] Starting dynamic subtest: pipe-C-DP-3
[558.441248] Dynamic subtest pipe-C-DP-3: SKIP (0.000s)
[558.451758] Starting dynamic subtest: pipe-D-DP-3
[558.461364] Dynamic subtest pipe-D-DP-3: SKIP (0.000s)
[558.463460] Subtest missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc: SKIP (0.007s)
[558.861546] [100/131] (482s left) kms_ccs (crc-primary-rotation-180-4-tiled-dg2-rc-ccs)
[559.057523] Starting subtest: crc-primary-rotation-180-4-tiled-dg2-rc-ccs
[559.060033] Starting dynamic subtest: pipe-A-DP-3
[563.814060] Dynamic subtest pipe-A-DP-3: SUCCESS (4.751s)
[563.828590] Starting dynamic subtest: pipe-B-DP-3
[564.565536] Dynamic subtest pipe-B-DP-3: SUCCESS (0.745s)
[564.602231] Starting dynamic subtest: pipe-C-DP-3
[565.357948] Dynamic subtest pipe-C-DP-3: SUCCESS (0.777s)
[565.389995] Starting dynamic subtest: pipe-D-DP-3
[566.135549] Dynamic subtest pipe-D-DP-3: SUCCESS (0.777s)
[566.137206] Subtest crc-primary-rotation-180-4-tiled-dg2-rc-ccs: SUCCESS (7.075s)
[566.491086] [101/131] (474s left) device_reset (unbind-reset-rebind)
[566.578455] Starting subtest: unbind-reset-rebind
[569.111486] Subtest unbind-reset-rebind: SUCCESS (2.533s)
[569.166509] [102/131] (471s left) gem_sync (basic-many-each)
[569.256436] Starting subtest: basic-many-each
[571.695280] Subtest basic-many-each: SUCCESS (2.438s)
[571.973218] [103/131] (469s left) kms_frontbuffer_tracking (fbc-1p-rte)
[572.175117] Starting subtest: fbc-1p-rte
[575.661668] Subtest fbc-1p-rte: SUCCESS (3.487s)
[575.892652] [104/131] (465s left) i915_pm_rpm (debugfs-forcewake-user)
[578.028340] Starting subtest: debugfs-forcewake-user
[588.706361] Subtest debugfs-forcewake-user: SUCCESS (10.682s)
[589.058568] [105/131] (452s left) perf (sysctl-defaults)
[589.158349] Starting subtest: sysctl-defaults
[589.159299] Subtest sysctl-defaults: SUCCESS (0.000s)
[589.491980] [106/131] (451s left) gem_create (hog-create)
[589.573374] Starting subtest: hog-create
[589.574292] Starting dynamic subtest: lmem0
[621.851343] Dynamic subtest lmem0: SUCCESS (32.277s)
[621.862636] Starting dynamic subtest: smem0
[654.102396] Dynamic subtest smem0: SUCCESS (32.249s)
[654.103384] Subtest hog-create: SUCCESS (64.528s)
[654.357774] [107/131] (387s left) kms_big_fb (yf-tiled-64bpp-rotate-0)
[654.567144] Starting subtest: yf-tiled-64bpp-rotate-0
[654.568865] Subtest yf-tiled-64bpp-rotate-0: SKIP (0.000s)
[654.699202] [108/131] (386s left) kms_frontbuffer_tracking (fbc-1p-offscren-pri-indfb-draw-blt)
[654.901077] Starting subtest: fbc-1p-offscren-pri-indfb-draw-blt
[657.183139] Subtest fbc-1p-offscren-pri-indfb-draw-blt: SUCCESS (2.282s)
[657.378425] [109/131] (384s left) gem_pwrite_snooped
[657.540157] [110/131] (384s left) gem_mmap_gtt (fault-concurrent)
[657.617257] Subtest fault-concurrent: SKIP (0.000s)
[657.693660] [111/131] (383s left) gem_softpin (noreloc-s3)
[657.783285] Starting subtest: noreloc-S3
[677.655398] Subtest noreloc-S3: SUCCESS (5.425s)
[695.834349] [112/131] (363s left) api_intel_bb (lot-of-buffers)
[695.913541] Starting subtest: lot-of-buffers
[699.106817] Subtest lot-of-buffers: SUCCESS (3.193s)
[699.325837] [113/131] (360s left) gen7_exec_parse (load-register-reg)
[699.413980] Subtest load-register-reg: SKIP (0.000s)
[699.500554] [114/131] (360s left) kms_plane_scaling (planes-scaler-unity-scaling)
[699.696579] Starting subtest: planes-scaler-unity-scaling
[699.697500] Starting dynamic subtest: pipe-A
[699.784788] Dynamic subtest pipe-A: SUCCESS (0.088s)
[699.805363] Starting dynamic subtest: pipe-B
[700.000137] Dynamic subtest pipe-B: SUCCESS (0.214s)
[700.017145] Starting dynamic subtest: pipe-C
[700.200351] Dynamic subtest pipe-C: SUCCESS (0.199s)
[700.224567] Starting dynamic subtest: pipe-D
[700.415531] Dynamic subtest pipe-D: SUCCESS (0.214s)
[700.416619] Subtest planes-scaler-unity-scaling: SUCCESS (0.720s)
[700.749337] [115/131] (359s left) gem_lmem_swapping (verify-random-ccs)
[703.497375] Starting subtest: verify-random-ccs
[703.498236] Starting dynamic subtest: lmem0
[708.394065] Dynamic subtest lmem0: SUCCESS (4.896s)
[708.395008] Subtest verify-random-ccs: SUCCESS (4.897s)
[709.565793] [FACT gem_lmem_swapping (verify-random-ccs)] deleted: hardware.pci.drm_card_at_addr.0000:03:00.0: card1
[709.566801] [FACT gem_lmem_swapping (verify-random-ccs)] deleted: kernel.kmod_is_loaded.i915: true
[709.569127] [116/131] (350s left) kms_big_fb (4-tiled-addfb-size-overflow)
[711.143352] Starting subtest: 4-tiled-addfb-size-overflow
[711.144243] Subtest 4-tiled-addfb-size-overflow: SUCCESS (0.001s)
[711.292938] [FACT kms_big_fb (4-tiled-addfb-size-overflow)] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card1
[711.295734] [FACT kms_big_fb (4-tiled-addfb-size-overflow)] new: kernel.kmod_is_loaded.i915: true
[711.298728] [117/131] (348s left) kms_properties (get_properties-sanity-atomic)
[711.494622] Starting subtest: get_properties-sanity-atomic
[711.498269] Subtest get_properties-sanity-atomic: SUCCESS (0.004s)
[711.586694] [118/131] (348s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-32bpp-xtile-upscaling)
[711.789853] Starting subtest: flip-64bpp-xtile-to-32bpp-xtile-upscaling
[711.792209] Starting dynamic subtest: pipe-A-valid-mode
[713.620127] Dynamic subtest pipe-A-valid-mode: SUCCESS (1.826s)
[713.621516] Subtest flip-64bpp-xtile-to-32bpp-xtile-upscaling: SUCCESS (1.830s)
[713.874127] [119/131] (346s left) kms_psr (psr2-cursor-mmap-gtt)
[714.074371] Subtest psr2-cursor-mmap-gtt: SKIP (0.000s)
[714.131486] [120/131] (346s left) kms_psr (fbc-pr-sprite-blt)
[714.329210] Subtest fbc-pr-sprite-blt: SKIP (0.000s)
[714.384080] [121/131] (345s left) syncobj_wait (single-wait-submitted)
[714.468551] Starting subtest: single-wait-submitted
[714.583752] Subtest single-wait-submitted: SUCCESS (0.108s)
[714.708735] [122/131] (345s left) gem_close (basic)
[714.801915] Starting subtest: basic
[714.802734] Subtest basic: SUCCESS (0.000s)
[714.920002] [123/131] (345s left) prime_mmap (test_forked_cpu_write)
[715.004799] Starting subtest: test_forked_cpu_write
[715.005675] Starting dynamic subtest: test_forked_cpu_write-smem
[715.013553] Dynamic subtest test_forked_cpu_write-smem: SUCCESS (0.008s)
[715.026774] Starting dynamic subtest: test_forked_cpu_write-lmem0
[715.027907] Dynamic subtest test_forked_cpu_write-lmem0: SUCCESS (0.009s)
[715.029017] Subtest test_forked_cpu_write: SUCCESS (0.019s)
[715.207274] [124/131] (345s left) kms_frontbuffer_tracking (psr-1p-primscrn-indfb-pgflip-blt)
[715.410633] Starting subtest: psr-1p-primscrn-indfb-pgflip-blt
[715.412325] Subtest psr-1p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[715.536049] [125/131] (345s left) perf_pmu (busy-no-semaphores)
[715.608476] Starting subtest: busy-no-semaphores
[715.609436] Starting dynamic subtest: rcs0
[716.167222] Dynamic subtest rcs0: SUCCESS (0.557s)
[716.185517] Starting dynamic subtest: bcs0
[716.723626] Dynamic subtest bcs0: SUCCESS (0.551s)
[716.741749] Starting dynamic subtest: vcs0
[717.281161] Dynamic subtest vcs0: SUCCESS (0.552s)
[717.299497] Starting dynamic subtest: vcs1
[717.838143] Dynamic subtest vcs1: SUCCESS (0.552s)
[717.856622] Starting dynamic subtest: vecs0
[718.394282] Dynamic subtest vecs0: SUCCESS (0.551s)
[718.412732] Starting dynamic subtest: vecs1
[718.949080] Dynamic subtest vecs1: SUCCESS (0.550s)
[718.967524] Starting dynamic subtest: ccs0
[719.504670] Dynamic subtest ccs0: SUCCESS (0.551s)
[719.511403] Subtest busy-no-semaphores: SUCCESS (3.898s)
[719.713510] [126/131] (340s left) kms_cursor_edge_walk (128x128-left-edge)
[719.911657] Starting subtest: 128x128-left-edge
[719.914225] Starting dynamic subtest: pipe-A-DP-3
[723.397064] Dynamic subtest pipe-A-DP-3: SUCCESS (3.483s)
[723.419535] Starting dynamic subtest: pipe-D-DP-3
[726.744530] Dynamic subtest pipe-D-DP-3: SUCCESS (3.344s)
[726.745521] Subtest 128x128-left-edge: SUCCESS (6.833s)
[726.998465] [127/131] (333s left) kms_pipe_stress (stress-xrgb8888-yftiled)
[727.201001] Starting subtest: stress-xrgb8888-yftiled
[727.202642] Subtest stress-xrgb8888-yftiled: SKIP (0.000s)
[727.279946] [128/131] (333s left) gem_exec_schedule (wide)
[727.490346] Starting subtest: wide
[727.491293] Starting dynamic subtest: rcs0
[739.826446] Dynamic subtest rcs0: SUCCESS (12.335s)
[739.839881] Starting dynamic subtest: bcs0
[752.670597] Dynamic subtest bcs0: SUCCESS (12.843s)
[752.683470] Starting dynamic subtest: vcs0
[766.059043] Dynamic subtest vcs0: SUCCESS (13.385s)
[766.072194] Starting dynamic subtest: vcs1
[779.249878] Dynamic subtest vcs1: SUCCESS (13.193s)
[779.262696] Starting dynamic subtest: vecs0
[792.615636] Dynamic subtest vecs0: SUCCESS (13.364s)
[792.630602] Starting dynamic subtest: vecs1
[806.029702] Dynamic subtest vecs1: SUCCESS (13.409s)
[806.046001] Starting dynamic subtest: ccs0
[818.697798] Dynamic subtest ccs0: SUCCESS (12.668s)
[818.698635] Subtest wide: SUCCESS (91.208s)
[820.613777] [129/131] (240s left) gem_render_copy (y-tiled-ccs-to-y-tiled-ccs)
[820.700992] Starting subtest: y-tiled-ccs-to-y-tiled-ccs
[820.703242] Subtest y-tiled-ccs-to-y-tiled-ccs: SKIP (0.000s)
[820.938346] [130/131] (239s left) syncobj_timeline (invalid-query-one-illegal-handle)
[821.018366] Starting subtest: invalid-query-one-illegal-handle
[821.019323] Subtest invalid-query-one-illegal-handle: SUCCESS (0.000s)
[821.168624] [131/131] (239s left) gem_mmap_offset (pf-nonblock)
[821.252467] Starting subtest: pf-nonblock
[821.290065] Subtest pf-nonblock: SUCCESS (0.038s)
[821.431344] Closing watchdogs
results: parsing output: 0/ for test: kms_frontbuffer_tracking
results: parsing output: 1/ for test: kms_flip
results: parsing output: 2/ for test: kms_plane
results: parsing output: 3/ for test: kms_flip
results: parsing output: 4/ for test: gem_tiled_pread_basic
results: parsing output: 5/ for test: kms_big_fb
results: parsing output: 6/ for test: kms_psr
results: parsing output: 7/ for test: kms_ccs
results: parsing output: 8/ for test: kms_getfb
results: parsing output: 9/ for test: kms_pm_rpm
results: parsing output: 10/ for test: kms_frontbuffer_tracking
results: parsing output: 11/ for test: kms_chamelium_hpd
results: parsing output: 12/ for test: gem_pread
results: parsing output: 13/ for test: gem_bad_reloc
results: parsing output: 14/ for test: sriov_basic
results: parsing output: 15/ for test: gem_ctx_param
results: parsing output: 16/ for test: syncobj_wait
results: parsing output: 17/ for test: kms_frontbuffer_tracking
results: parsing output: 18/ for test: kms_flip
results: parsing output: 19/ for test: kms_psr
results: parsing output: 20/ for test: gem_softpin
results: parsing output: 21/ for test: drm_read
results: parsing output: 22/ for test: i915_drm_fdinfo
results: parsing output: 23/ for test: i915_drm_fdinfo
results: parsing output: 24/ for test: kms_frontbuffer_tracking
results: parsing output: 25/ for test: kms_psr
results: parsing output: 26/ for test: kms_ccs
results: parsing output: 27/ for test: kms_dp_link_training
results: parsing output: 28/ for test: kms_psr2_sf
results: parsing output: 29/ for test: perf
results: parsing output: 30/ for test: kms_cursor_legacy
results: parsing output: 31/ for test: kms_color
results: parsing output: 32/ for test: kms_pipe_b_c_ivb
results: parsing output: 33/ for test: kms_async_flips
results: parsing output: 34/ for test: kms_lease
results: parsing output: 35/ for test: kms_frontbuffer_tracking
results: parsing output: 36/ for test: sysfs_timeslice_duration
results: parsing output: 37/ for test: gem_userptr_blits
results: parsing output: 38/ for test: gem_mmap_gtt
results: parsing output: 39/ for test: syncobj_wait
results: parsing output: 40/ for test: kms_frontbuffer_tracking
results: parsing output: 41/ for test: gem_exec_fence
results: parsing output: 42/ for test: kms_frontbuffer_tracking
results: parsing output: 43/ for test: syncobj_timeline
results: parsing output: 44/ for test: gem_spin_batch
results: parsing output: 45/ for test: kms_big_fb
results: parsing output: 46/ for test: api_intel_allocator
results: parsing output: 47/ for test: kms_frontbuffer_tracking
results: parsing output: 48/ for test: kms_big_fb
results: parsing output: 49/ for test: kms_frontbuffer_tracking
results: parsing output: 50/ for test: kms_frontbuffer_tracking
results: parsing output: 51/ for test: kms_cursor_crc
results: parsing output: 52/ for test: gem_request_retire
results: parsing output: 53/ for test: gem_exec_schedule
results: parsing output: 54/ for test: gem_userptr_blits
results: parsing output: 55/ for test: kms_ccs
results: parsing output: 56/ for test: kms_psr2_sf
results: parsing output: 57/ for test: kms_selftest
results: parsing output: 58/ for test: kms_vblank
results: parsing output: 59/ for test: kms_hdr
results: parsing output: 60/ for test: kms_frontbuffer_tracking
results: parsing output: 61/ for test: gem_exec_schedule
results: parsing output: 62/ for test: tools_test
results: parsing output: 63/ for test: gem_tiled_partial_pwrite_pread
results: parsing output: 64/ for test: gem_userptr_blits
results: parsing output: 65/ for test: gem_create
results: parsing output: 66/ for test: kms_big_fb
results: parsing output: 67/ for test: kms_frontbuffer_tracking
results: parsing output: 68/ for test: gem_exec_params
results: parsing output: 69/ for test: gem_exec_fence
results: parsing output: 70/ for test: gem_eio
results: parsing output: 71/ for test: kms_flip_scaled_crc
results: parsing output: 72/ for test: kms_content_protection
results: parsing output: 73/ for test: kms_fbcon_fbt
results: parsing output: 74/ for test: gem_exec_reloc
results: parsing output: 75/ for test: syncobj_wait
results: parsing output: 76/ for test: kms_frontbuffer_tracking
results: parsing output: 77/ for test: gem_ctx_persistence
results: parsing output: 78/ for test: kms_chamelium_edid
results: parsing output: 79/ for test: gem_userptr_blits
results: parsing output: 80/ for test: kms_flip
results: parsing output: 81/ for test: gem_pipe_control_store_loop
results: parsing output: 82/ for test: gem_exec_alignment
results: parsing output: 83/ for test: kms_plane
results: parsing output: 84/ for test: syncobj_wait
results: parsing output: 85/ for test: kms_flip
results: parsing output: 86/ for test: kms_vblank
results: parsing output: 87/ for test: syncobj_timeline
results: parsing output: 88/ for test: kms_pm_rpm
results: parsing output: 89/ for test: kms_atomic_transition
results: parsing output: 90/ for test: kms_cursor_crc
results: parsing output: 91/ for test: gem_exec_balancer
results: parsing output: 92/ for test: gem_userptr_blits
results: parsing output: 93/ for test: i915_pm_rpm
results: parsing output: 94/ for test: syncobj_timeline
results: parsing output: 95/ for test: syncobj_timeline
results: parsing output: 96/ for test: kms_addfb_basic
results: parsing output: 97/ for test: gem_exec_whisper
results: parsing output: 98/ for test: kms_ccs
results: parsing output: 99/ for test: kms_ccs
results: parsing output: 100/ for test: device_reset
results: parsing output: 101/ for test: gem_sync
results: parsing output: 102/ for test: kms_frontbuffer_tracking
results: parsing output: 103/ for test: i915_pm_rpm
results: parsing output: 104/ for test: perf
results: parsing output: 105/ for test: gem_create
results: parsing output: 106/ for test: kms_big_fb
results: parsing output: 107/ for test: kms_frontbuffer_tracking
results: parsing output: 108/ for test: gem_pwrite_snooped
results: parsing output: 109/ for test: gem_mmap_gtt
results: parsing output: 110/ for test: gem_softpin
results: parsing output: 111/ for test: api_intel_bb
results: parsing output: 112/ for test: gen7_exec_parse
results: parsing output: 113/ for test: kms_plane_scaling
results: parsing output: 114/ for test: gem_lmem_swapping
results: parsing output: 115/ for test: kms_big_fb
results: parsing output: 116/ for test: kms_properties
results: parsing output: 117/ for test: kms_flip_scaled_crc
results: parsing output: 118/ for test: kms_psr
results: parsing output: 119/ for test: kms_psr
results: parsing output: 120/ for test: syncobj_wait
results: parsing output: 121/ for test: gem_close
results: parsing output: 122/ for test: prime_mmap
results: parsing output: 123/ for test: kms_frontbuffer_tracking
results: parsing output: 124/ for test: perf_pmu
results: parsing output: 125/ for test: kms_cursor_edge_walk
results: parsing output: 126/ for test: kms_pipe_stress
results: parsing output: 127/ for test: gem_exec_schedule
results: parsing output: 128/ for test: gem_render_copy
results: parsing output: 129/ for test: syncobj_timeline
results: parsing output: 130/ for test: gem_mmap_offset
Done.