[56.400166] Initializing watchdogs
[56.400310]   /dev/watchdog0
[56.415519] [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.419939] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[56.422141] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[56.425610] [001/133] (960s left) kms_cursor_crc (cursor-random-512x512)
[56.738951] Starting subtest: cursor-random-512x512
[56.744114] Subtest cursor-random-512x512: SKIP (0.001s)
[56.888841] [002/133] (960s left) gem_eio (context-create)
[57.057020] Starting subtest: context-create
[57.262225] Subtest context-create: SUCCESS (0.205s)
[57.400318] [003/133] (959s left) kms_frontbuffer_tracking (psr-2p-rte)
[57.499059] Starting subtest: psr-2p-rte
[57.502513] Subtest psr-2p-rte: SKIP (0.000s)
[57.590563] [004/133] (959s left) kms_ccs (crc-sprite-planes-basic-4-tiled-mtl-mc-ccs)
[57.674519] Starting subtest: crc-sprite-planes-basic-4-tiled-mtl-mc-ccs
[57.676808] Starting dynamic subtest: pipe-A-eDP-1
[57.952777] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.255s)
[57.960571] Starting dynamic subtest: pipe-B-eDP-1
[59.196879] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.236s)
[59.205560] Starting dynamic subtest: pipe-C-eDP-1
[60.496798] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.308s)
[60.506497] Starting dynamic subtest: pipe-D-eDP-1
[61.732509] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.240s)
[61.734522] Subtest crc-sprite-planes-basic-4-tiled-mtl-mc-ccs: SUCCESS (4.042s)
[62.926784] [005/133] (954s left) gem_exec_gttfill (all-engines)
[62.998199] Starting subtest: all-engines
[85.955462] Subtest all-engines: SUCCESS (22.969s)
[86.145922] [006/133] (930s left) gen7_exec_parse (basic-rejected)
[86.250964] Subtest basic-rejected: SKIP (0.000s)
[86.321945] [007/133] (930s left) gem_set_tiling_vs_blt (tiled-to-tiled)
[86.378399] Subtest tiled-to-tiled: SKIP (0.000s)
[86.451335] [008/133] (930s left) syncobj_wait (multi-wait-submitted)
[86.511302] Starting subtest: multi-wait-submitted
[86.618300] Subtest multi-wait-submitted: SUCCESS (0.104s)
[86.693930] [009/133] (930s left) gem_render_copy (y-tiled-ccs-to-x-tiled)
[86.758390] Starting subtest: y-tiled-ccs-to-x-tiled
[86.762793] Subtest y-tiled-ccs-to-x-tiled: SKIP (0.000s)
[86.941011] [010/133] (930s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-onoff)
[87.045423] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-onoff
[94.071872] Subtest fbcpsr-1p-primscrn-cur-indfb-onoff: SUCCESS (7.029s)
[94.217429] [011/133] (923s left) gem_exec_balancer (fairslice)
[94.287840] Starting subtest: fairslice
[97.221344] Subtest fairslice: SUCCESS (2.932s)
[97.551683] [012/133] (919s left) gem_ctx_param (invalid-size-get)
[97.608780] Starting subtest: invalid-size-get
[97.611254] Subtest invalid-size-get: SUCCESS (0.001s)
[97.711830] [013/133] (919s left) kms_cursor_legacy (short-flip-after-cursor-toggle)
[97.842198] Starting subtest: short-flip-after-cursor-toggle
[98.792945] Subtest short-flip-after-cursor-toggle: SUCCESS (0.948s)
[99.674273] [014/133] (917s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-rc-ccs)
[99.771050] Starting subtest: crc-primary-suspend-4-tiled-dg2-rc-ccs
[99.773398] Starting dynamic subtest: pipe-A-eDP-1
[99.782675] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[99.792741] Starting dynamic subtest: pipe-B-eDP-1
[99.801704] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[99.810069] Starting dynamic subtest: pipe-C-eDP-1
[99.819079] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[99.827211] Starting dynamic subtest: pipe-D-eDP-1
[99.835926] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[99.840266] Subtest crc-primary-suspend-4-tiled-dg2-rc-ccs: SKIP (0.003s)
[101.966466] [015/133] (915s left) kms_plane_scaling (plane-scaler-with-clipping-clamping-pixel-formats)
[102.054277] Starting subtest: plane-scaler-with-clipping-clamping-pixel-formats
[102.056633] Starting dynamic subtest: pipe-A
[102.166640] Dynamic subtest pipe-A: SKIP (0.108s)
[102.182516] Starting dynamic subtest: pipe-B
[103.326627] Dynamic subtest pipe-B: SKIP (1.157s)
[103.335707] Starting dynamic subtest: pipe-C
[104.553632] Dynamic subtest pipe-C: SUCCESS (1.234s)
[104.563776] Starting dynamic subtest: pipe-D
[105.700418] Dynamic subtest pipe-D: SUCCESS (1.146s)
[105.702766] Subtest plane-scaler-with-clipping-clamping-pixel-formats: SUCCESS (3.647s)
[106.894261] [016/133] (910s left) kms_color_pipeline (plane-lut1d-post-ctm3x4)
[107.008418] Starting subtest: plane-lut1d-post-ctm3x4
[107.189331] Starting dynamic subtest: pipe-A-plane-0
[107.355865] Dynamic subtest pipe-A-plane-0: SUCCESS (0.167s)
[107.365817] Starting dynamic subtest: pipe-A-plane-1
[107.511366] Dynamic subtest pipe-A-plane-1: SUCCESS (0.155s)
[107.520432] Starting dynamic subtest: pipe-A-plane-2
[107.666963] Dynamic subtest pipe-A-plane-2: SUCCESS (0.155s)
[108.890362] Starting dynamic subtest: pipe-B-plane-0
[109.061510] Dynamic subtest pipe-B-plane-0: SUCCESS (0.178s)
[109.070419] Starting dynamic subtest: pipe-B-plane-1
[109.250607] Dynamic subtest pipe-B-plane-1: SUCCESS (0.189s)
[109.259093] Starting dynamic subtest: pipe-B-plane-2
[109.405981] Dynamic subtest pipe-B-plane-2: SUCCESS (0.155s)
[110.624203] Starting dynamic subtest: pipe-C-plane-0
[110.784823] Dynamic subtest pipe-C-plane-0: SUCCESS (0.167s)
[110.795083] Starting dynamic subtest: pipe-C-plane-1
[110.972611] Dynamic subtest pipe-C-plane-1: SUCCESS (0.188s)
[110.981416] Starting dynamic subtest: pipe-C-plane-2
[111.128275] Dynamic subtest pipe-C-plane-2: SUCCESS (0.155s)
[112.330511] Starting dynamic subtest: pipe-D-plane-0
[112.479343] Dynamic subtest pipe-D-plane-0: SUCCESS (0.155s)
[112.488178] Starting dynamic subtest: pipe-D-plane-1
[112.623454] Dynamic subtest pipe-D-plane-1: SUCCESS (0.144s)
[112.632871] Starting dynamic subtest: pipe-D-plane-2
[112.767982] Dynamic subtest pipe-D-plane-2: SUCCESS (0.144s)
[113.056340] Subtest plane-lut1d-post-ctm3x4: SUCCESS (6.047s)
[113.898363] [017/133] (903s left) kms_plane (pixel-format-y-tiled-gen12-mc-ccs-modifier)
[114.003481] Starting subtest: pixel-format-y-tiled-gen12-mc-ccs-modifier
[114.007843] Subtest pixel-format-y-tiled-gen12-mc-ccs-modifier: SKIP (0.000s)
[114.072590] [018/133] (903s left) api_intel_allocator (fork-simple-stress)
[114.122624] Starting subtest: fork-simple-stress
[119.518455] Subtest fork-simple-stress: SUCCESS (5.396s)
[119.638694] [019/133] (897s left) gem_reg_read (timestamp-monotonic)
[119.690741] Starting subtest: timestamp-monotonic
[124.581843] Subtest timestamp-monotonic: SUCCESS (4.890s)
[124.656799] [020/133] (893s left) gem_workarounds (reset-fd)
[124.733555] Starting subtest: reset-fd
[124.929601] Subtest reset-fd: SUCCESS (0.196s)
[125.088605] [021/133] (892s left) kms_flip (2x-flip-vs-modeset-vs-hang)
[125.210196] Starting subtest: 2x-flip-vs-modeset-vs-hang
[125.219360] Subtest 2x-flip-vs-modeset-vs-hang: SKIP (0.011s)
[125.296887] [022/133] (892s left) gem_exec_endless (dispatch)
[125.398678] Starting subtest: dispatch
[125.401098] Starting dynamic subtest: rcs0
[125.408658] Dynamic subtest rcs0: SUCCESS (0.011s)
[125.418094] Starting dynamic subtest: bcs0
[125.422226] Dynamic subtest bcs0: SUCCESS (0.011s)
[125.432160] Starting dynamic subtest: vcs0
[125.436180] Dynamic subtest vcs0: SUCCESS (0.007s)
[125.449318] Starting dynamic subtest: vcs1
[125.453989] Dynamic subtest vcs1: SUCCESS (0.008s)
[125.462064] Starting dynamic subtest: vecs0
[125.466337] Dynamic subtest vecs0: SUCCESS (0.005s)
[125.474136] Starting dynamic subtest: ccs0
[125.478222] Dynamic subtest ccs0: SUCCESS (0.005s)
[125.480440] Subtest dispatch: SUCCESS (0.052s)
[126.907903] [023/133] (890s left) kms_tiled_display (basic-test-pattern)
[127.015311] Subtest basic-test-pattern: SKIP (0.000s)
[127.057216] [024/133] (890s left) kms_flip_scaled_crc (flip-32bpp-linear-to-64bpp-linear-upscaling)
[127.150084] Starting subtest: flip-32bpp-linear-to-64bpp-linear-upscaling
[127.152446] Starting dynamic subtest: pipe-A-default-mode
[129.940446] Dynamic subtest pipe-A-default-mode: SUCCESS (2.791s)
[129.942844] Subtest flip-32bpp-linear-to-64bpp-linear-upscaling: SUCCESS (2.792s)
[130.794264] [025/133] (887s left) gem_tiled_partial_pwrite_pread (reads)
[130.844103] Subtest reads: SKIP (0.000s)
[130.933191] [026/133] (887s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-blt)
[131.021572] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-blt
[131.025746] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-blt: SKIP (0.000s)
[131.141855] [027/133] (886s left) syncobj_timeline (etime-single-wait-all-for-submit-submitted)
[131.197280] Starting subtest: etime-single-wait-all-for-submit-submitted
[131.306380] Subtest etime-single-wait-all-for-submit-submitted: SUCCESS (0.108s)
[131.378711] [028/133] (886s left) syncobj_timeline (multi-wait-for-submit-available-submitted-signaled)
[131.427464] Starting subtest: multi-wait-for-submit-available-submitted-signaled
[131.429494] Subtest multi-wait-for-submit-available-submitted-signaled: SUCCESS (0.000s)
[131.518648] [029/133] (886s left) gem_mmap_offset (bad-flags)
[131.572269] Starting subtest: bad-flags
[131.574254] Subtest bad-flags: SUCCESS (0.000s)
[131.663857] [030/133] (886s left) kms_addfb_basic (bad-pitch-65536)
[131.707200] Starting subtest: bad-pitch-65536
[131.709422] Subtest bad-pitch-65536: SUCCESS (0.000s)
[131.845582] [031/133] (886s left) kms_big_fb (linear-64bpp-rotate-0)
[131.950296] Starting subtest: linear-64bpp-rotate-0
[133.584188] Subtest linear-64bpp-rotate-0: SUCCESS (1.634s)
[133.756912] [032/133] (884s left) kms_atomic_interruptible (legacy-setmode)
[133.852190] Starting subtest: legacy-setmode
[133.854437] Starting dynamic subtest: pipe-A-eDP-1
[140.756270] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.903s)
[140.758641] Subtest legacy-setmode: SUCCESS (6.904s)
[141.617098] [033/133] (876s left) kms_invalid_mode (zero-clock)
[141.703020] Starting subtest: zero-clock
[141.705266] Starting dynamic subtest: pipe-A-eDP-1
[141.989394] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.285s)
[141.998722] Starting dynamic subtest: pipe-B-eDP-1
[142.000937] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[142.008945] Starting dynamic subtest: pipe-C-eDP-1
[142.011286] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[142.019355] Starting dynamic subtest: pipe-D-eDP-1
[142.021631] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[142.023979] Subtest zero-clock: SUCCESS (0.290s)
[142.838284] [034/133] (875s left) gem_eio (in-flight-external)
[143.058377] Starting subtest: in-flight-external
[144.986554] Subtest in-flight-external: SUCCESS (1.927s)
[145.101887] [035/133] (873s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180-async-flip)
[145.196157] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180-async-flip
[145.876042] Subtest x-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SUCCESS (0.681s)
[146.036986] [036/133] (872s left) gem_exec_schedule (in-order)
[146.116395] Starting subtest: in-order
[146.118347] Starting dynamic subtest: rcs0
[146.211688] Dynamic subtest rcs0: SUCCESS (0.103s)
[146.223831] Starting dynamic subtest: vcs0
[146.297572] Dynamic subtest vcs0: SUCCESS (0.085s)
[146.308562] Starting dynamic subtest: vcs1
[146.381479] Dynamic subtest vcs1: SUCCESS (0.083s)
[146.393188] Starting dynamic subtest: vecs0
[146.468063] Dynamic subtest vecs0: SUCCESS (0.086s)
[146.479309] Starting dynamic subtest: ccs0
[146.569039] Dynamic subtest ccs0: SUCCESS (0.100s)
[146.571683] Subtest in-order: SUCCESS (0.461s)
[148.011495] [037/133] (870s left) kms_vblank (wait-forked-busy)
[148.106179] Starting subtest: wait-forked-busy
[148.108348] Starting dynamic subtest: pipe-A-eDP-1
[150.006185] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.900s)
[150.024190] Starting dynamic subtest: pipe-D-eDP-1
[152.604768] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.595s)
[152.606645] Subtest wait-forked-busy: SUCCESS (4.499s)
[153.415300] [038/133] (865s left) vgem_slow (nohang)
[153.547949] Starting subtest: nohang
[163.955429] Subtest nohang: SUCCESS (10.408s)
[164.033058] [FACT vgem_slow (nohang)] new: kernel.kmod_is_loaded.vgem: true
[164.036268] [039/133] (854s left) kms_atomic_transition (plane-all-modeset-transition-internal-panels)
[164.129969] Starting subtest: plane-all-modeset-transition-internal-panels
[164.131933] Starting dynamic subtest: pipe-A-eDP-1
[165.446894] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.316s)
[165.725735] Starting dynamic subtest: pipe-B-eDP-1
[166.768451] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.054s)
[167.041929] Subtest plane-all-modeset-transition-internal-panels: SUCCESS (2.914s)
[167.876122] [040/133] (850s left) kms_plane_scaling (plane-upscale-20x20-with-pixel-format)
[167.978062] Starting subtest: plane-upscale-20x20-with-pixel-format
[167.980616] Starting dynamic subtest: pipe-A
[169.024731] Dynamic subtest pipe-A: SUCCESS (1.050s)
[169.033244] Starting dynamic subtest: pipe-B
[171.185252] Dynamic subtest pipe-B: SUCCESS (2.160s)
[171.193202] Starting dynamic subtest: pipe-C
[172.387579] Dynamic subtest pipe-C: SUCCESS (1.200s)
[172.397800] Starting dynamic subtest: pipe-D
[173.621147] Dynamic subtest pipe-D: SUCCESS (1.232s)
[173.623535] Subtest plane-upscale-20x20-with-pixel-format: SUCCESS (5.647s)
[174.832009] [041/133] (843s left) kms_plane_cursor (primary)
[174.921321] Starting subtest: primary
[174.925800] Starting dynamic subtest: pipe-A-eDP-1-size-64
[177.483955] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.563s)
[177.507585] Starting dynamic subtest: pipe-A-eDP-1-size-128
[180.062560] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.560s)
[180.088866] Starting dynamic subtest: pipe-A-eDP-1-size-256
[182.630165] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.549s)
[182.945827] Starting dynamic subtest: pipe-B-eDP-1-size-64
[186.200680] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.266s)
[186.228400] Starting dynamic subtest: pipe-B-eDP-1-size-128
[188.801060] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.583s)
[188.825187] Starting dynamic subtest: pipe-B-eDP-1-size-256
[191.379605] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.561s)
[191.694287] Starting dynamic subtest: pipe-C-eDP-1-size-64
[194.584330] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (2.900s)
[194.610297] Starting dynamic subtest: pipe-C-eDP-1-size-128
[196.784436] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.180s)
[196.811404] Starting dynamic subtest: pipe-C-eDP-1-size-256
[199.007859] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.202s)
[199.343907] Starting dynamic subtest: pipe-D-eDP-1-size-64
[202.230079] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (2.896s)
[202.255443] Starting dynamic subtest: pipe-D-eDP-1-size-128
[204.418200] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.169s)
[204.444752] Starting dynamic subtest: pipe-D-eDP-1-size-256
[206.652314] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.214s)
[206.966690] Subtest primary: SUCCESS (32.045s)
[207.769443] [042/133] (810s left) kms_atomic_transition (plane-primary-toggle-with-vblank-wait)
[207.864146] Starting subtest: plane-primary-toggle-with-vblank-wait
[207.866583] Starting dynamic subtest: pipe-A-eDP-1
[208.035838] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.174s)
[208.347448] Starting dynamic subtest: pipe-B-eDP-1
[209.274528] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.934s)
[209.573088] Subtest plane-primary-toggle-with-vblank-wait: SUCCESS (1.711s)
[210.432160] [043/133] (808s left) syncobj_timeline (invalid-query-illegal-handle)
[210.494804] Starting subtest: invalid-query-illegal-handle
[210.497175] Subtest invalid-query-illegal-handle: SUCCESS (0.000s)
[210.597521] [044/133] (808s left) kms_dirtyfb (fbc-dirtyfb-ioctl)
[210.702294] Starting subtest: fbc-dirtyfb-ioctl
[210.704619] Starting dynamic subtest: A-eDP-1
[213.306422] Dynamic subtest A-eDP-1: SUCCESS (2.605s)
[213.308725] Subtest fbc-dirtyfb-ioctl: SUCCESS (2.606s)
[214.101681] [045/133] (804s left) kms_addfb_basic (invalid-get-prop)
[214.163235] Starting subtest: invalid-get-prop
[214.165406] Subtest invalid-get-prop: SUCCESS (0.000s)
[214.299738] [046/133] (804s left) syncobj_wait (wait-for-submit-snapshot)
[214.361301] Starting subtest: wait-for-submit-snapshot
[214.445450] Subtest wait-for-submit-snapshot: SUCCESS (0.083s)
[214.549292] [047/133] (804s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-pwrite)
[214.640505] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-pwrite
[214.644974] Subtest fbc-2p-scndscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[214.768684] [048/133] (804s left) i915_drm_fdinfo (memory-info-active)
[214.813836] Starting subtest: memory-info-active
[214.816125] Starting dynamic subtest: smem0
[217.312945] Dynamic subtest smem0: SUCCESS (2.501s)
[217.315388] Subtest memory-info-active: SUCCESS (2.502s)
[217.386817] [049/133] (801s left) api_intel_bb (object-noreloc-purge-cache-simple)
[217.444303] Starting subtest: object-noreloc-purge-cache-simple
[217.451336] Subtest object-noreloc-purge-cache-simple: SUCCESS (0.009s)
[217.576356] [050/133] (801s left) kms_psr (psr-cursor-mmap-gtt)
[217.670212] Starting subtest: psr-cursor-mmap-gtt
[217.672040] Starting dynamic subtest: eDP-1
[219.392499] Dynamic subtest eDP-1: SUCCESS (1.723s)
[219.394776] Subtest psr-cursor-mmap-gtt: SUCCESS (1.724s)
[220.266297] [051/133] (798s left) kms_pipe_crc_basic (suspend-read-crc)
[220.357972] Starting subtest: suspend-read-crc
[220.360292] Starting dynamic subtest: pipe-A-eDP-1
[238.056686] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.731s)
[238.066764] Starting dynamic subtest: pipe-B-eDP-1
[256.036422] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.206s)
[256.046753] Starting dynamic subtest: pipe-C-eDP-1
[274.017942] Dynamic subtest pipe-C-eDP-1: SUCCESS (3.131s)
[274.028085] Starting dynamic subtest: pipe-D-eDP-1
[291.992209] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.042s)
[291.994496] Subtest suspend-read-crc: SUCCESS (12.116s)
[292.805867] [052/133] (726s left) kms_chamelium_hpd (hdmi-hpd-fast)
[293.203036] Subtest hdmi-hpd-fast: SKIP (0.000s)
[294.002941] [053/133] (725s left) kms_cursor_crc (cursor-tearing-position-change)
[294.114076] Starting subtest: cursor-tearing-position-change
[294.116587] Starting dynamic subtest: pipe-A-eDP-1
[294.673122] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.563s)
[294.683404] Starting dynamic subtest: pipe-D-eDP-1
[295.931587] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.269s)
[295.934030] Subtest cursor-tearing-position-change: SUCCESS (1.835s)
[296.754083] [054/133] (722s left) perf (short-reads)
[296.892965] Starting subtest: short-reads
[296.905967] Subtest short-reads: SUCCESS (0.016s)
[296.955476] [055/133] (722s left) kms_chamelium_edid (dp-mode-timings)
[297.356365] Subtest dp-mode-timings: SKIP (0.000s)
[298.172494] [056/133] (721s left) kms_psr (fbc-pr-sprite-mmap-gtt)
[298.267738] Starting subtest: fbc-pr-sprite-mmap-gtt
[298.272624] Subtest fbc-pr-sprite-mmap-gtt: SKIP (0.000s)
[298.339848] [057/133] (720s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-pwrite)
[298.438307] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-pwrite
[307.703858] Subtest psr-1p-offscreen-pri-shrfb-draw-pwrite: SUCCESS (9.308s)
[307.829365] [058/133] (711s left) gem_pxp (verify-pxp-key-change-after-suspend-resume)
[307.947411] Starting subtest: verify-pxp-key-change-after-suspend-resume
[315.913387] Subtest verify-pxp-key-change-after-suspend-resume: SUCCESS (7.981s)
[316.018859] [059/133] (703s left) gem_exec_reloc (basic-cpu-read-noreloc)
[316.083878] Subtest basic-cpu-read-noreloc: SKIP (0.000s)
[316.142856] [060/133] (703s left) perf (mi-rpc)
[316.242604] Starting subtest: mi-rpc
[316.247844] Subtest mi-rpc: SKIP (0.000s)
[316.290848] [061/133] (703s left) kms_frontbuffer_tracking (fbcpsr-tiling-4)
[316.385594] Starting subtest: fbcpsr-tiling-4
[323.534444] Subtest fbcpsr-tiling-4: SUCCESS (7.153s)
[323.659267] [062/133] (695s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc)
[323.755461] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc
[323.760080] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[323.851028] [063/133] (695s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-shrfb-msflip-blt)
[323.948091] Starting subtest: fbcpsr-2p-scndscrn-shrfb-msflip-blt
[323.953328] Subtest fbcpsr-2p-scndscrn-shrfb-msflip-blt: SKIP (0.000s)
[324.039063] [064/133] (695s left) kms_lease (lease-uevent)
[324.140437] Starting subtest: lease-uevent
[325.150725] Subtest lease-uevent: SUCCESS (1.012s)
[325.229534] [065/133] (694s left) kms_pm_backlight (brightness-with-dpms)
[325.335878] Starting subtest: brightness-with-dpms
[325.428367] Starting dynamic subtest: eDP-1
[331.044456] Dynamic subtest eDP-1: SUCCESS (5.619s)
[331.047433] Subtest brightness-with-dpms: SUCCESS (5.710s)
[331.916589] [066/133] (687s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-mmap-cpu)
[332.039402] Starting subtest: psr-2p-primscrn-pri-indfb-draw-mmap-cpu
[332.045249] Subtest psr-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[332.155735] [067/133] (687s left) kms_flip (2x-plain-flip-fb-recreate)
[332.246137] Starting subtest: 2x-plain-flip-fb-recreate
[332.254457] Subtest 2x-plain-flip-fb-recreate: SKIP (0.010s)
[332.335428] [068/133] (687s left) gem_wait (await)
[332.397463] Starting subtest: await
[332.400204] Starting dynamic subtest: all-engines
[333.484847] Dynamic subtest all-engines: SUCCESS (1.087s)
[333.501535] Starting dynamic subtest: rcs0
[334.548448] Dynamic subtest rcs0: SUCCESS (1.062s)
[334.566635] Starting dynamic subtest: bcs0
[335.611755] Dynamic subtest bcs0: SUCCESS (1.062s)
[335.630448] Starting dynamic subtest: vcs0
[336.671826] Dynamic subtest vcs0: SUCCESS (1.058s)
[336.689430] Starting dynamic subtest: vcs1
[337.728819] Dynamic subtest vcs1: SUCCESS (1.055s)
[337.745878] Starting dynamic subtest: vecs0
[338.785217] Dynamic subtest vecs0: SUCCESS (1.054s)
[338.803081] Starting dynamic subtest: ccs0
[339.846429] Dynamic subtest ccs0: SUCCESS (1.059s)
[339.849597] Subtest await: SUCCESS (7.450s)
[340.042801] [069/133] (679s left) kms_psr (fbc-psr-primary-page-flip)
[340.139370] Starting subtest: fbc-psr-primary-page-flip
[340.142123] Starting dynamic subtest: eDP-1
[340.147360] Dynamic subtest eDP-1: SKIP (0.000s)
[340.152424] Subtest fbc-psr-primary-page-flip: SKIP (0.001s)
[340.213296] [070/133] (679s left) kms_big_fb (4-tiled-32bpp-rotate-0)
[340.322337] Starting subtest: 4-tiled-32bpp-rotate-0
[341.702539] Subtest 4-tiled-32bpp-rotate-0: SUCCESS (1.381s)
[341.821674] [071/133] (678s left) kms_async_flips (async-flip-dpms)
[341.910890] Starting subtest: async-flip-dpms
[342.300325] Starting dynamic subtest: pipe-A-eDP-1
[346.135401] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.836s)
[346.506615] Starting dynamic subtest: pipe-B-eDP-1
[349.304219] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.805s)
[349.696025] Starting dynamic subtest: pipe-C-eDP-1
[352.469634] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.781s)
[352.846734] Starting dynamic subtest: pipe-D-eDP-1
[355.630276] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.791s)
[355.632710] Subtest async-flip-dpms: SUCCESS (13.722s)
[356.812990] [072/133] (663s left) kms_cdclk (mode-transition-all-outputs)
[356.902081] Starting subtest: mode-transition-all-outputs
[357.190383] Subtest mode-transition-all-outputs: SKIP (0.287s)
[358.040463] [073/133] (661s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-blt)
[358.138130] Starting subtest: fbc-rgb101010-draw-blt
[362.751968] Subtest fbc-rgb101010-draw-blt: SUCCESS (4.619s)
[363.948877] [074/133] (656s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-mmap-cpu)
[364.062004] Starting subtest: psr-1p-primscrn-cur-indfb-draw-mmap-cpu
[370.612362] Subtest psr-1p-primscrn-cur-indfb-draw-mmap-cpu: SUCCESS (6.556s)
[370.715131] [075/133] (649s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-blt)
[370.819826] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-blt
[370.824329] Subtest fbc-2p-scndscrn-pri-indfb-draw-blt: SKIP (0.000s)
[370.908633] [076/133] (649s left) perf_pmu (gt-awake)
[370.952340] Starting subtest: gt-awake
[379.545443] Subtest gt-awake: SUCCESS (8.595s)
[379.652402] [077/133] (640s left) i915_getparams_basic (basic-eu-total)
[379.712649] Starting subtest: basic-eu-total
[379.718472] Subtest basic-eu-total: SUCCESS (0.000s)
[379.800933] [078/133] (640s left) kms_prop_blob (basic)
[379.867642] Starting subtest: basic
[379.870187] Subtest basic: SUCCESS (0.000s)
[379.967874] [079/133] (640s left) gem_mmap_wc (write-wc-read-gtt)
[380.027441] Subtest write-wc-read-gtt: SKIP (0.000s)
[380.091418] [080/133] (640s left) kms_cursor_crc (cursor-offscreen-128x42)
[380.322473] Starting subtest: cursor-offscreen-128x42
[380.369227] Subtest cursor-offscreen-128x42: SKIP (0.041s)
[380.557591] [081/133] (639s left) kms_psr (pr-sprite-render)
[380.646438] Starting subtest: pr-sprite-render
[380.650852] Subtest pr-sprite-render: SKIP (0.000s)
[380.724375] [082/133] (639s left) syncobj_timeline (etime-multi-wait-all-available-unsubmitted-signaled)
[380.778419] Starting subtest: etime-multi-wait-all-available-unsubmitted-signaled
[380.883929] Subtest etime-multi-wait-all-available-unsubmitted-signaled: SUCCESS (0.104s)
[380.959214] [083/133] (639s left) perf_pmu (semaphore-wait-idle)
[381.004652] Starting subtest: semaphore-wait-idle
[381.007429] Starting dynamic subtest: rcs0
[381.515952] Dynamic subtest rcs0: SUCCESS (0.513s)
[381.529765] Starting dynamic subtest: bcs0
[382.029968] Dynamic subtest bcs0: SUCCESS (0.511s)
[382.041622] Starting dynamic subtest: vcs0
[382.543959] Dynamic subtest vcs0: SUCCESS (0.511s)
[382.557777] Starting dynamic subtest: vcs1
[383.058076] Dynamic subtest vcs1: SUCCESS (0.512s)
[383.071296] Starting dynamic subtest: vecs0
[383.571206] Dynamic subtest vecs0: SUCCESS (0.510s)
[383.585293] Starting dynamic subtest: ccs0
[384.090339] Dynamic subtest ccs0: SUCCESS (0.516s)
[384.093805] Subtest semaphore-wait-idle: SUCCESS (3.091s)
[385.634367] [084/133] (634s left) gem_exec_reloc (basic-cpu)
[385.688412] Subtest basic-cpu: SKIP (0.000s)
[385.756972] [085/133] (634s left) gem_exec_fence (keep-in-fence)
[385.942046] Starting subtest: keep-in-fence
[385.945003] Starting dynamic subtest: rcs0
[386.013629] Dynamic subtest rcs0: SUCCESS (0.072s)
[386.025510] Starting dynamic subtest: bcs0
[386.073062] Dynamic subtest bcs0: SUCCESS (0.057s)
[386.085753] Starting dynamic subtest: vcs0
[387.543932] Dynamic subtest vcs0: SUCCESS (1.468s)
[387.557166] Starting dynamic subtest: vcs1
[389.592003] Dynamic subtest vcs1: SUCCESS (2.046s)
[389.603881] Starting dynamic subtest: vecs0
[391.576283] Dynamic subtest vecs0: SUCCESS (1.982s)
[391.594095] Starting dynamic subtest: ccs0
[391.809150] Dynamic subtest ccs0: SUCCESS (0.232s)
[391.811995] Subtest keep-in-fence: SUCCESS (5.871s)
[393.636787] [086/133] (626s left) gem_exec_whisper (basic-fds-forked)
[393.706045] Starting subtest: basic-fds-forked
[419.623758] Subtest basic-fds-forked: SUCCESS (25.923s)
[419.809741] [087/133] (600s left) gem_ctx_isolation (dirty-create)
[419.894575] Starting subtest: dirty-create
[419.896897] Starting dynamic subtest: rcs0
[420.145200] Dynamic subtest rcs0: SUCCESS (0.250s)
[420.160294] Starting dynamic subtest: bcs0
[420.422077] Dynamic subtest bcs0: SUCCESS (0.277s)
[420.432452] Starting dynamic subtest: vcs0
[420.708627] Dynamic subtest vcs0: SUCCESS (0.285s)
[420.719188] Starting dynamic subtest: vcs1
[421.818652] Dynamic subtest vcs1: SUCCESS (1.109s)
[421.831076] Starting dynamic subtest: vecs0
[423.817530] Dynamic subtest vecs0: SUCCESS (1.999s)
[423.830279] Starting dynamic subtest: ccs0
[425.781898] Dynamic subtest ccs0: SUCCESS (1.964s)
[425.784655] Subtest dirty-create: SUCCESS (5.889s)
[426.023041] [088/133] (594s left) kms_content_protection (lic-type-1)
[426.175482] Starting subtest: lic-type-1
[426.181119] Subtest lic-type-1: SKIP (0.000s)
[426.301872] [089/133] (594s left) gem_exec_create (madvise)
[426.367520] Starting subtest: madvise
[426.370355] Starting dynamic subtest: smem
[447.640400] Dynamic subtest smem: SUCCESS (21.279s)
[447.643478] Subtest madvise: SUCCESS (21.280s)
[448.892818] [090/133] (571s left) kms_prop_blob (invalid-get-prop-any)
[448.948389] Starting subtest: invalid-get-prop-any
[448.951154] Subtest invalid-get-prop-any: SUCCESS (0.000s)
[449.056200] [091/133] (571s left) kms_ccs (ccs-on-another-bo-y-tiled-ccs)
[449.152642] Starting subtest: ccs-on-another-bo-y-tiled-ccs
[449.155200] Starting dynamic subtest: pipe-A-eDP-1
[449.179606] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[449.190281] Starting dynamic subtest: pipe-B-eDP-1
[449.215239] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[449.225382] Starting dynamic subtest: pipe-C-eDP-1
[449.250493] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[449.260462] Starting dynamic subtest: pipe-D-eDP-1
[449.286444] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[449.291379] Subtest ccs-on-another-bo-y-tiled-ccs: SKIP (0.004s)
[451.407907] [092/133] (569s left) gem_ctx_engines (execute-one)
[451.465772] Starting subtest: execute-one
[453.788066] Subtest execute-one: SUCCESS (2.324s)
[453.982889] [093/133] (566s left) gem_spin_batch (resubmit-new)
[454.043776] Starting subtest: resubmit-new
[454.045974] Starting dynamic subtest: rcs0
[454.060511] Dynamic subtest rcs0: SUCCESS (0.016s)
[454.070597] Starting dynamic subtest: bcs0
[454.073100] Dynamic subtest bcs0: SUCCESS (0.009s)
[454.083426] Starting dynamic subtest: vcs0
[454.086258] Dynamic subtest vcs0: SUCCESS (0.008s)
[454.096914] Starting dynamic subtest: vcs1
[454.099246] Dynamic subtest vcs1: SUCCESS (0.009s)
[454.111974] Starting dynamic subtest: vecs0
[454.113965] Dynamic subtest vecs0: SUCCESS (0.010s)
[454.124863] Starting dynamic subtest: ccs0
[454.126850] Dynamic subtest ccs0: SUCCESS (0.007s)
[454.128629] Subtest resubmit-new: SUCCESS (0.064s)
[455.618355] [094/133] (565s left) gem_ccs (ctrl-surf-copy)
[455.682013] Starting subtest: ctrl-surf-copy
[455.687207] Subtest ctrl-surf-copy: SKIP (0.000s)
[455.789283] [095/133] (565s left) kms_flip (flip-vs-fences)
[455.886626] Starting subtest: flip-vs-fences
[455.891542] Subtest flip-vs-fences: SKIP (0.000s)
[455.976991] [096/133] (564s left) kms_big_fb (x-tiled-32bpp-rotate-90)
[456.078347] Starting subtest: x-tiled-32bpp-rotate-90
[456.097884] Subtest x-tiled-32bpp-rotate-90: SKIP (0.019s)
[456.200737] [097/133] (564s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-blt)
[456.300373] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-blt
[456.305612] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-blt: SKIP (0.000s)
[456.396224] [098/133] (564s left) gem_exec_await (wide-all)
[456.671605] Starting subtest: wide-all
[480.419749] Subtest wide-all: SUCCESS (23.756s)
[480.627295] [099/133] (540s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-32bpp-xtile-downscaling)
[480.768326] Starting subtest: flip-64bpp-xtile-to-32bpp-xtile-downscaling
[480.770982] Starting dynamic subtest: pipe-A-default-mode
[481.950244] Dynamic subtest pipe-A-default-mode: SKIP (1.179s)
[481.955138] Subtest flip-64bpp-xtile-to-32bpp-xtile-downscaling: SKIP (1.181s)
[482.084293] [100/133] (539s left) kms_feature_discovery (psr1)
[482.187634] Starting subtest: psr1
[482.190458] Subtest psr1: SUCCESS (0.000s)
[482.260994] [101/133] (538s left) gem_exec_schedule (u-lateslice)
[482.368473] Starting subtest: u-lateslice
[482.371218] Starting dynamic subtest: rcs0
[482.377324] Dynamic subtest rcs0: SUCCESS (0.023s)
[482.388265] Starting dynamic subtest: bcs0
[482.399345] Dynamic subtest bcs0: SUCCESS (0.021s)
[482.411598] Starting dynamic subtest: vcs0
[482.418316] Dynamic subtest vcs0: SUCCESS (0.018s)
[482.429391] Starting dynamic subtest: vcs1
[482.437625] Dynamic subtest vcs1: SUCCESS (0.018s)
[482.448162] Starting dynamic subtest: vecs0
[482.455383] Dynamic subtest vecs0: SUCCESS (0.017s)
[482.465490] Starting dynamic subtest: ccs0
[482.472634] Dynamic subtest ccs0: SUCCESS (0.017s)
[482.475387] Subtest u-lateslice: SUCCESS (0.119s)
[483.638727] [102/133] (537s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-move)
[483.753501] Starting subtest: psr-1p-primscrn-spr-indfb-move
[491.305903] Subtest psr-1p-primscrn-spr-indfb-move: SUCCESS (7.560s)
[491.433402] [103/133] (529s left) kms_psr_stress_test (invalidate-primary-flip-overlay)
[491.528141] Starting subtest: invalidate-primary-flip-overlay
[502.290191] Subtest invalidate-primary-flip-overlay: SUCCESS (10.769s)
[502.407084] [104/133] (518s left) kms_psr2_sf (psr2-plane-move-sf-dmg-area)
[502.503974] Starting subtest: psr2-plane-move-sf-dmg-area
[502.506254] Starting dynamic subtest: pipe-A-eDP-1
[507.079346] Dynamic subtest pipe-A-eDP-1: SUCCESS (4.582s)
[507.090628] Starting dynamic subtest: pipe-B-eDP-1
[512.392413] Dynamic subtest pipe-B-eDP-1: SUCCESS (5.313s)
[512.395232] Subtest psr2-plane-move-sf-dmg-area: SUCCESS (9.898s)
[513.258111] [105/133] (508s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-pwrite)
[513.355204] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-pwrite
[518.101616] Subtest fbc-1p-offscreen-pri-indfb-draw-pwrite: SUCCESS (4.753s)
[519.264040] [106/133] (502s left) kms_cursor_legacy (basic-flip-after-cursor-atomic)
[519.384424] Starting subtest: basic-flip-after-cursor-atomic
[520.332762] Subtest basic-flip-after-cursor-atomic: SUCCESS (0.948s)
[521.182301] [107/133] (500s left) kms_flip (dpms-vs-vblank-race-interruptible)
[521.272391] Starting subtest: dpms-vs-vblank-race-interruptible
[521.274906] Starting dynamic subtest: A-eDP1
[526.189220] Dynamic subtest A-eDP1: SUCCESS (4.917s)
[526.200198] Starting dynamic subtest: B-eDP1
[529.705540] Dynamic subtest B-eDP1: SUCCESS (3.518s)
[529.717601] Starting dynamic subtest: C-eDP1
[533.199380] Dynamic subtest C-eDP1: SUCCESS (3.493s)
[533.210869] Starting dynamic subtest: D-eDP1
[537.834449] Dynamic subtest D-eDP1: SUCCESS (4.633s)
[537.837324] Subtest dpms-vs-vblank-race-interruptible: SUCCESS (16.573s)
[538.708106] [108/133] (482s left) gem_render_copy (y-tiled-to-vebox-yf-tiled)
[538.767090] Starting subtest: y-tiled-to-vebox-yf-tiled
[538.772608] Subtest y-tiled-to-vebox-yf-tiled: SKIP (0.000s)
[538.955144] [109/133] (482s left) perf_pmu (all-busy-check-all)
[539.011433] Starting subtest: all-busy-check-all
[540.566971] Subtest all-busy-check-all: SUCCESS (1.556s)
[540.663620] [110/133] (480s left) i915_pm_rps (thresholds-idle)
[540.727935] Starting subtest: thresholds-idle
[540.733212] Subtest thresholds-idle: SKIP (0.001s)
[540.830274] [111/133] (480s left) kms_flip (modeset-vs-vblank-race)
[540.920340] Starting subtest: modeset-vs-vblank-race
[540.922934] Starting dynamic subtest: A-eDP1
[545.622443] Dynamic subtest A-eDP1: SUCCESS (4.703s)
[545.635427] Starting dynamic subtest: B-eDP1
[550.326050] Dynamic subtest B-eDP1: SUCCESS (4.703s)
[550.338218] Starting dynamic subtest: C-eDP1
[554.944208] Dynamic subtest C-eDP1: SUCCESS (4.618s)
[554.955296] Starting dynamic subtest: D-eDP1
[559.560156] Dynamic subtest D-eDP1: SUCCESS (4.617s)
[559.562750] Subtest modeset-vs-vblank-race: SUCCESS (18.652s)
[560.714325] [112/133] (460s left) kms_frontbuffer_tracking (psr-rgb565-draw-mmap-gtt)
[560.812837] Starting subtest: psr-rgb565-draw-mmap-gtt
[560.818191] Subtest psr-rgb565-draw-mmap-gtt: SKIP (0.000s)
[560.921114] [113/133] (460s left) dmabuf_sync_file (export-multiwait)
[560.971492] Starting subtest: export-multiwait
[560.973890] Subtest export-multiwait: SUCCESS (0.000s)
[561.035083] [114/133] (460s left) kms_flip (nonexisting-fb)
[561.124627] Starting subtest: nonexisting-fb
[561.127386] Starting dynamic subtest: A-eDP1
[562.297260] Dynamic subtest A-eDP1: SUCCESS (1.172s)
[562.315280] Starting dynamic subtest: B-eDP1
[563.434429] Dynamic subtest B-eDP1: SUCCESS (1.135s)
[563.445667] Starting dynamic subtest: C-eDP1
[564.567009] Dynamic subtest C-eDP1: SUCCESS (1.132s)
[564.579463] Starting dynamic subtest: D-eDP1
[565.699912] Dynamic subtest D-eDP1: SUCCESS (1.131s)
[565.705608] Subtest nonexisting-fb: SUCCESS (4.584s)
[566.873599] [115/133] (454s left) sysfs_timeslice_duration (idempotent)
[566.924953] Starting subtest: idempotent
[566.927773] Starting dynamic subtest: vecs0
[566.930512] Dynamic subtest vecs0: SUCCESS (0.000s)
[566.941642] Starting dynamic subtest: ccs0
[566.944067] Dynamic subtest ccs0: SUCCESS (0.000s)
[566.953888] Starting dynamic subtest: vcs0
[566.956172] Dynamic subtest vcs0: SUCCESS (0.000s)
[566.966082] Starting dynamic subtest: bcs0
[566.968457] Dynamic subtest bcs0: SUCCESS (0.000s)
[566.978866] Starting dynamic subtest: rcs0
[566.981537] Dynamic subtest rcs0: SUCCESS (0.000s)
[566.991649] Starting dynamic subtest: vcs1
[566.993885] Dynamic subtest vcs1: SUCCESS (0.000s)
[566.996010] Subtest idempotent: SUCCESS (0.007s)
[567.036006] [116/133] (454s left) gem_exec_params (invalid-fence-in)
[567.116886] Starting subtest: invalid-fence-in
[567.119447] Subtest invalid-fence-in: SUCCESS (0.000s)
[567.212543] [117/133] (454s left) kms_big_fb (yf-tiled-64bpp-rotate-180)
[567.315478] Starting subtest: yf-tiled-64bpp-rotate-180
[567.321387] Subtest yf-tiled-64bpp-rotate-180: SKIP (0.000s)
[567.428456] [118/133] (454s left) gem_lmem_swapping (verify-random)
[567.471545] Subtest verify-random: SKIP (0.000s)
[567.519717] [119/133] (454s left) kms_ccs (bad-pixel-format-4-tiled-dg2-mc-ccs)
[567.606624] Starting subtest: bad-pixel-format-4-tiled-dg2-mc-ccs
[567.609369] Starting dynamic subtest: pipe-A-eDP-1
[567.635625] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[567.646629] Starting dynamic subtest: pipe-B-eDP-1
[567.672440] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[567.683136] Starting dynamic subtest: pipe-C-eDP-1
[567.709391] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[567.719595] Starting dynamic subtest: pipe-D-eDP-1
[567.745623] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[567.750415] Subtest bad-pixel-format-4-tiled-dg2-mc-ccs: SKIP (0.004s)
[569.851088] [120/133] (452s left) i915_pm_rpm (system-suspend-devices)
[571.681627] Starting subtest: system-suspend-devices
[582.198522] Subtest system-suspend-devices: SUCCESS (10.518s)
[582.948528] [121/133] (439s left) gem_close_race (basic-threads)
[583.026329] Starting subtest: basic-threads
[584.398164] Subtest basic-threads: SUCCESS (1.370s)
[584.596073] [122/133] (437s left) syncobj_timeline (wait-all-interrupted)
[584.654635] Starting subtest: wait-all-interrupted
[584.753881] Subtest wait-all-interrupted: SUCCESS (0.101s)
[584.835431] [123/133] (437s left) kms_flip (2x-flip-vs-panning-interruptible)
[584.930301] Starting subtest: 2x-flip-vs-panning-interruptible
[584.941014] Subtest 2x-flip-vs-panning-interruptible: SKIP (0.010s)
[585.017128] [124/133] (437s left) kms_atomic (plane-primary-legacy)
[585.106615] Starting subtest: plane-primary-legacy
[585.109556] Starting dynamic subtest: pipe-A-eDP-1
[585.555273] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.449s)
[585.557588] Subtest plane-primary-legacy: SUCCESS (0.450s)
[586.363625] [125/133] (435s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-blt)
[586.464584] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-blt
[586.469829] Subtest fbc-2p-primscrn-pri-indfb-draw-blt: SKIP (0.000s)
[586.574388] [126/133] (435s left) gem_lmem_swapping (massive-random)
[586.621286] Subtest massive-random: SKIP (0.000s)
[586.670340] [127/133] (435s left) gem_eio (in-flight-internal-10ms)
[586.878484] Starting subtest: in-flight-internal-10ms
[588.638864] Subtest in-flight-internal-10ms: SUCCESS (1.755s)
[588.791402] [128/133] (433s left) kms_busy (extended-pageflip-hang-newfb)
[588.883416] Starting subtest: extended-pageflip-hang-newfb
[588.886065] Starting dynamic subtest: pipe-A
[615.361442] Dynamic subtest pipe-A: SUCCESS (26.449s)
[615.373187] Starting dynamic subtest: pipe-D
[640.365249] Dynamic subtest pipe-D: SUCCESS (24.983s)
[640.367784] Subtest extended-pageflip-hang-newfb: SUCCESS (51.436s)
[641.162386] [129/133] (381s left) kms_psr2_sf (pr-overlay-plane-move-continuous-exceed-fully-sf)
[641.272183] Starting subtest: pr-overlay-plane-move-continuous-exceed-fully-sf
[641.277437] Subtest pr-overlay-plane-move-continuous-exceed-fully-sf: SKIP (0.000s)
[641.342608] [130/133] (381s left) gem_ctx_persistence (legacy-engines-persistence)
[641.401503] Starting subtest: legacy-engines-persistence
[641.404016] Starting dynamic subtest: render
[642.200135] Dynamic subtest render: SUCCESS (0.800s)
[642.213996] Starting dynamic subtest: bsd1
[642.969490] Dynamic subtest bsd1: SUCCESS (0.766s)
[642.983352] Starting dynamic subtest: bsd2
[643.728629] Dynamic subtest bsd2: SUCCESS (0.756s)
[643.741527] Starting dynamic subtest: blt
[644.504581] Dynamic subtest blt: SUCCESS (0.773s)
[644.517595] Starting dynamic subtest: vebox
[645.265800] Dynamic subtest vebox: SUCCESS (0.758s)
[645.268585] Subtest legacy-engines-persistence: SUCCESS (3.867s)
[645.361485] [131/133] (377s left) kms_big_fb (y-tiled-8bpp-rotate-0)
[645.465537] Starting subtest: y-tiled-8bpp-rotate-0
[645.470549] Subtest y-tiled-8bpp-rotate-0: SKIP (0.000s)
[645.570482] [132/133] (376s left) kms_rotation_crc (primary-yf-tiled-reflect-x-180)
[645.668185] Starting subtest: primary-yf-tiled-reflect-x-180
[645.728246] Subtest primary-yf-tiled-reflect-x-180: SKIP (0.060s)
[645.843867] [133/133] (376s left) kms_vrr (seamless-rr-switch-virtual)
[645.945406] Starting subtest: seamless-rr-switch-virtual
[645.952326] Subtest seamless-rr-switch-virtual: SKIP (0.000s)
[646.014564] Closing watchdogs
results: parsing output: 0/ for test: kms_cursor_crc
results: parsing output: 1/ for test: gem_eio
results: parsing output: 2/ for test: kms_frontbuffer_tracking
results: parsing output: 3/ for test: kms_ccs
results: parsing output: 4/ for test: gem_exec_gttfill
results: parsing output: 5/ for test: gen7_exec_parse
results: parsing output: 6/ for test: gem_set_tiling_vs_blt
results: parsing output: 7/ for test: syncobj_wait
results: parsing output: 8/ for test: gem_render_copy
results: parsing output: 9/ for test: kms_frontbuffer_tracking
results: parsing output: 10/ for test: gem_exec_balancer
results: parsing output: 11/ for test: gem_ctx_param
results: parsing output: 12/ for test: kms_cursor_legacy
results: parsing output: 13/ for test: kms_ccs
results: parsing output: 14/ for test: kms_plane_scaling
results: parsing output: 15/ for test: kms_color_pipeline
results: parsing output: 16/ for test: kms_plane
results: parsing output: 17/ for test: api_intel_allocator
results: parsing output: 18/ for test: gem_reg_read
results: parsing output: 19/ for test: gem_workarounds
results: parsing output: 20/ for test: kms_flip
results: parsing output: 21/ for test: gem_exec_endless
results: parsing output: 22/ for test: kms_tiled_display
results: parsing output: 23/ for test: kms_flip_scaled_crc
results: parsing output: 24/ for test: gem_tiled_partial_pwrite_pread
results: parsing output: 25/ for test: kms_frontbuffer_tracking
results: parsing output: 26/ for test: syncobj_timeline
results: parsing output: 27/ for test: syncobj_timeline
results: parsing output: 28/ for test: gem_mmap_offset
results: parsing output: 29/ for test: kms_addfb_basic
results: parsing output: 30/ for test: kms_big_fb
results: parsing output: 31/ for test: kms_atomic_interruptible
results: parsing output: 32/ for test: kms_invalid_mode
results: parsing output: 33/ for test: gem_eio
results: parsing output: 34/ for test: kms_big_fb
results: parsing output: 35/ for test: gem_exec_schedule
results: parsing output: 36/ for test: kms_vblank
results: parsing output: 37/ for test: vgem_slow
results: parsing output: 38/ for test: kms_atomic_transition
results: parsing output: 39/ for test: kms_plane_scaling
results: parsing output: 40/ for test: kms_plane_cursor
results: parsing output: 41/ for test: kms_atomic_transition
results: parsing output: 42/ for test: syncobj_timeline
results: parsing output: 43/ for test: kms_dirtyfb
results: parsing output: 44/ for test: kms_addfb_basic
results: parsing output: 45/ for test: syncobj_wait
results: parsing output: 46/ for test: kms_frontbuffer_tracking
results: parsing output: 47/ for test: i915_drm_fdinfo
results: parsing output: 48/ for test: api_intel_bb
results: parsing output: 49/ for test: kms_psr
results: parsing output: 50/ for test: kms_pipe_crc_basic
results: parsing output: 51/ for test: kms_chamelium_hpd
results: parsing output: 52/ for test: kms_cursor_crc
results: parsing output: 53/ for test: perf
results: parsing output: 54/ for test: kms_chamelium_edid
results: parsing output: 55/ for test: kms_psr
results: parsing output: 56/ for test: kms_frontbuffer_tracking
results: parsing output: 57/ for test: gem_pxp
results: parsing output: 58/ for test: gem_exec_reloc
results: parsing output: 59/ for test: perf
results: parsing output: 60/ for test: kms_frontbuffer_tracking
results: parsing output: 61/ for test: kms_frontbuffer_tracking
results: parsing output: 62/ for test: kms_frontbuffer_tracking
results: parsing output: 63/ for test: kms_lease
results: parsing output: 64/ for test: kms_pm_backlight
results: parsing output: 65/ for test: kms_frontbuffer_tracking
results: parsing output: 66/ for test: kms_flip
results: parsing output: 67/ for test: gem_wait
results: parsing output: 68/ for test: kms_psr
results: parsing output: 69/ for test: kms_big_fb
results: parsing output: 70/ for test: kms_async_flips
results: parsing output: 71/ for test: kms_cdclk
results: parsing output: 72/ for test: kms_frontbuffer_tracking
results: parsing output: 73/ for test: kms_frontbuffer_tracking
results: parsing output: 74/ for test: kms_frontbuffer_tracking
results: parsing output: 75/ for test: perf_pmu
results: parsing output: 76/ for test: i915_getparams_basic
results: parsing output: 77/ for test: kms_prop_blob
results: parsing output: 78/ for test: gem_mmap_wc
results: parsing output: 79/ for test: kms_cursor_crc
results: parsing output: 80/ for test: kms_psr
results: parsing output: 81/ for test: syncobj_timeline
results: parsing output: 82/ for test: perf_pmu
results: parsing output: 83/ for test: gem_exec_reloc
results: parsing output: 84/ for test: gem_exec_fence
results: parsing output: 85/ for test: gem_exec_whisper
results: parsing output: 86/ for test: gem_ctx_isolation
results: parsing output: 87/ for test: kms_content_protection
results: parsing output: 88/ for test: gem_exec_create
results: parsing output: 89/ for test: kms_prop_blob
results: parsing output: 90/ for test: kms_ccs
results: parsing output: 91/ for test: gem_ctx_engines
results: parsing output: 92/ for test: gem_spin_batch
results: parsing output: 93/ for test: gem_ccs
results: parsing output: 94/ for test: kms_flip
results: parsing output: 95/ for test: kms_big_fb
results: parsing output: 96/ for test: kms_frontbuffer_tracking
results: parsing output: 97/ for test: gem_exec_await
results: parsing output: 98/ for test: kms_flip_scaled_crc
results: parsing output: 99/ for test: kms_feature_discovery
results: parsing output: 100/ for test: gem_exec_schedule
results: parsing output: 101/ for test: kms_frontbuffer_tracking
results: parsing output: 102/ for test: kms_psr_stress_test
results: parsing output: 103/ for test: kms_psr2_sf
results: parsing output: 104/ for test: kms_frontbuffer_tracking
results: parsing output: 105/ for test: kms_cursor_legacy
results: parsing output: 106/ for test: kms_flip
results: parsing output: 107/ for test: gem_render_copy
results: parsing output: 108/ for test: perf_pmu
results: parsing output: 109/ for test: i915_pm_rps
results: parsing output: 110/ for test: kms_flip
results: parsing output: 111/ for test: kms_frontbuffer_tracking
results: parsing output: 112/ for test: dmabuf_sync_file
results: parsing output: 113/ for test: kms_flip
results: parsing output: 114/ for test: sysfs_timeslice_duration
results: parsing output: 115/ for test: gem_exec_params
results: parsing output: 116/ for test: kms_big_fb
results: parsing output: 117/ for test: gem_lmem_swapping
results: parsing output: 118/ for test: kms_ccs
results: parsing output: 119/ for test: i915_pm_rpm
results: parsing output: 120/ for test: gem_close_race
results: parsing output: 121/ for test: syncobj_timeline
results: parsing output: 122/ for test: kms_flip
results: parsing output: 123/ for test: kms_atomic
results: parsing output: 124/ for test: kms_frontbuffer_tracking
results: parsing output: 125/ for test: gem_lmem_swapping
results: parsing output: 126/ for test: gem_eio
results: parsing output: 127/ for test: kms_busy
results: parsing output: 128/ for test: kms_psr2_sf
results: parsing output: 129/ for test: gem_ctx_persistence
results: parsing output: 130/ for test: kms_big_fb
results: parsing output: 131/ for test: kms_rotation_crc
results: parsing output: 132/ for test: kms_vrr
Done.