[58.210758] Initializing watchdogs
[58.210875]   /dev/watchdog0
[58.235996] [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]
[58.240646] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[58.243439] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[58.246908] [001/133] (960s left) gem_softpin (evict-active)
[58.338340] Starting subtest: evict-active
[58.346469] Subtest evict-active: SUCCESS (0.008s)
[58.480958] [002/133] (960s left) kms_panel_fitting (atomic-fastset)
[58.578741] Starting subtest: atomic-fastset
[58.580950] Starting dynamic subtest: pipe-A-eDP-1
[58.751356] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.174s)
[58.759243] Starting dynamic subtest: pipe-B-eDP-1
[60.015874] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.262s)
[60.025524] Starting dynamic subtest: pipe-C-eDP-1
[61.212796] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.195s)
[61.220505] Starting dynamic subtest: pipe-D-eDP-1
[62.356732] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.141s)
[62.359249] Subtest atomic-fastset: SUCCESS (3.774s)
[63.485472] [003/133] (955s left) gem_lmem_swapping (smem-oom)
[63.535912] Subtest smem-oom: SKIP (0.000s)
[63.576563] [004/133] (955s left) gem_blits (basic)
[63.626036] Starting subtest: basic
[65.007906] Subtest basic: SUCCESS (1.379s)
[65.125286] [005/133] (953s left) kms_dp_linktrain_fallback (dsc-fallback)
[65.214060] Starting subtest: dsc-fallback
[65.220405] Subtest dsc-fallback: SKIP (0.000s)
[65.281676] [006/133] (953s left) kms_pm_backlight (bad-brightness)
[65.369999] Starting subtest: bad-brightness
[65.441907] Starting dynamic subtest: eDP-1
[65.756725] Dynamic subtest eDP-1: SUCCESS (0.315s)
[65.759416] Subtest bad-brightness: SUCCESS (0.388s)
[66.612042] [007/133] (952s left) kms_psr2_sf (fbc-psr2-primary-plane-update-sf-dmg-area)
[66.711609] Starting subtest: fbc-psr2-primary-plane-update-sf-dmg-area
[66.714601] Starting dynamic subtest: pipe-A-eDP-1
[66.805203] Dynamic subtest pipe-A-eDP-1: SKIP (0.100s)
[66.814431] Starting dynamic subtest: pipe-B-eDP-1
[67.988460] Dynamic subtest pipe-B-eDP-1: SKIP (1.181s)
[67.992546] Subtest fbc-psr2-primary-plane-update-sf-dmg-area: SKIP (1.282s)
[69.175946] [008/133] (949s left) kms_cursor_crc (cursor-random-64x21)
[69.349763] Starting subtest: cursor-random-64x21
[69.398034] Subtest cursor-random-64x21: SKIP (0.043s)
[69.655618] [009/133] (949s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-indfb-draw-mmap-gtt)
[69.755092] Starting subtest: fbc-2p-primscrn-pri-indfb-draw-mmap-gtt
[69.759189] Subtest fbc-2p-primscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[69.830815] [010/133] (949s left) kms_psr (psr-basic)
[69.931436] Starting subtest: psr-basic
[69.933882] Starting dynamic subtest: eDP-1
[71.550391] Dynamic subtest eDP-1: SUCCESS (1.618s)
[71.552629] Subtest psr-basic: SUCCESS (1.619s)
[72.420950] [011/133] (946s left) perf (gen12-group-exclusive-stream-sample-oa)
[72.542304] Starting subtest: gen12-group-exclusive-stream-sample-oa
[72.560457] Subtest gen12-group-exclusive-stream-sample-oa: SUCCESS (0.018s)
[72.596822] [012/133] (946s left) kms_getfb (getfb2-handle-protection)
[72.682237] Starting subtest: getfb2-handle-protection
[72.700631] Subtest getfb2-handle-protection: SUCCESS (0.020s)
[72.822870] [013/133] (946s left) prime_self_import (basic-with_one_bo_two_files)
[72.855350] Starting subtest: basic-with_one_bo_two_files
[72.876389] Subtest basic-with_one_bo_two_files: SUCCESS (0.022s)
[72.982713] [014/133] (946s left) kms_big_fb (x-tiled-32bpp-rotate-180)
[73.090908] Starting subtest: x-tiled-32bpp-rotate-180
[74.592301] Subtest x-tiled-32bpp-rotate-180: SUCCESS (1.501s)
[74.734813] [015/133] (944s left) kms_psr2_sf (fbc-pr-cursor-plane-move-continuous-sf)
[74.821867] Starting subtest: fbc-pr-cursor-plane-move-continuous-sf
[74.825453] Subtest fbc-pr-cursor-plane-move-continuous-sf: SKIP (0.000s)
[74.888820] [016/133] (944s left) kms_cursor_crc (cursor-onscreen-256x256)
[75.131166] Starting subtest: cursor-onscreen-256x256
[75.133202] Starting dynamic subtest: pipe-A-eDP-1
[77.220708] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.087s)
[77.248837] Starting dynamic subtest: pipe-D-eDP-1
[80.029942] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.787s)
[80.032246] Subtest cursor-onscreen-256x256: SUCCESS (4.899s)
[80.880215] [017/133] (938s left) syncobj_timeline (multi-wait-for-submit-unsubmitted-submitted-signaled)
[80.953823] Starting subtest: multi-wait-for-submit-unsubmitted-submitted-signaled
[80.956298] Subtest multi-wait-for-submit-unsubmitted-submitted-signaled: SUCCESS (0.001s)
[81.074904] [018/133] (938s left) syncobj_eventfd (binary-wait)
[81.133095] Starting subtest: binary-wait
[81.142561] Subtest binary-wait: SUCCESS (0.010s)
[81.219014] [019/133] (938s left) kms_selftest (drm_plane_helper)
[81.257191] Starting subtest: drm_plane_helper
[81.296290] Starting dynamic subtest: drm_test_check_plane_state
[81.400408] Dynamic subtest drm_test_check_plane_state: SUCCESS (0.104s)
[81.407291] Starting dynamic subtest: drm_test_check_invalid_plane_state
[81.509089] Dynamic subtest drm_test_check_invalid_plane_state: SUCCESS (0.106s)
[81.510989] Subtest drm_plane_helper: SUCCESS (0.251s)
[81.679111] [020/133] (937s left) i915_pm_rps (waitboost)
[81.742740] Starting subtest: waitboost
[87.832320] Subtest waitboost: SUCCESS (6.087s)
[87.948921] [021/133] (931s left) syncobj_timeline (invalid-transfer-bad-pad)
[88.001094] Starting subtest: invalid-transfer-bad-pad
[88.003152] Subtest invalid-transfer-bad-pad: SUCCESS (0.000s)
[88.108380] [022/133] (931s left) gem_render_copy (yf-tiled-ccs-to-x-tiled)
[88.179344] Starting subtest: yf-tiled-ccs-to-x-tiled
[88.183231] Subtest yf-tiled-ccs-to-x-tiled: SKIP (0.000s)
[88.360134] [023/133] (931s left) gem_exec_schedule (preempt-queue-chain)
[88.441992] Subtest preempt-queue-chain: SKIP (0.000s)
[88.736307] [024/133] (930s left) syncobj_wait (single-wait-all-submitted)
[88.793422] Starting subtest: single-wait-all-submitted
[88.899315] Subtest single-wait-all-submitted: SUCCESS (0.105s)
[88.972797] [025/133] (930s left) gem_mmap_offset (mmap-unmap)
[89.034768] Starting subtest: mmap-unmap
[89.036744] Starting dynamic subtest: smem0
[111.908978] Dynamic subtest smem0: SUCCESS (22.870s)
[111.912259] Subtest mmap-unmap: SUCCESS (22.871s)
[112.009370] [026/133] (907s left) gem_userptr_blits (userfault)
[112.076334] Starting subtest: userfault
[112.081877] Subtest userfault: SUCCESS (0.010s)
[112.199525] [027/133] (907s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0-hflip)
[112.302745] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0-hflip
[113.337438] Subtest x-tiled-max-hw-stride-32bpp-rotate-0-hflip: SUCCESS (1.034s)
[113.468050] [028/133] (906s left) kms_draw_crc (draw-method-blt)
[113.565193] Starting subtest: draw-method-blt
[113.566780] Starting dynamic subtest: xrgb8888-untiled
[113.841697] Dynamic subtest xrgb8888-untiled: SUCCESS (0.278s)
[113.850182] Starting dynamic subtest: rgb565-untiled
[114.086156] Dynamic subtest rgb565-untiled: SUCCESS (0.243s)
[114.094157] Starting dynamic subtest: xrgb2101010-untiled
[114.297753] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.210s)
[114.310565] Starting dynamic subtest: xbgr16161616f-untiled
[114.530481] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.232s)
[114.538816] Starting dynamic subtest: xrgb8888-xtiled
[114.652690] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.122s)
[114.661152] Starting dynamic subtest: rgb565-xtiled
[114.774719] Dynamic subtest rgb565-xtiled: SUCCESS (0.121s)
[114.783265] Starting dynamic subtest: xrgb2101010-xtiled
[114.897160] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.122s)
[114.906080] Starting dynamic subtest: xbgr16161616f-xtiled
[115.008235] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.110s)
[115.014840] Starting dynamic subtest: xrgb8888-4tiled
[115.130708] Dynamic subtest xrgb8888-4tiled: SUCCESS (0.122s)
[115.137382] Starting dynamic subtest: rgb565-4tiled
[115.253119] Dynamic subtest rgb565-4tiled: SUCCESS (0.121s)
[115.267485] Starting dynamic subtest: xrgb2101010-4tiled
[115.352695] Dynamic subtest xrgb2101010-4tiled: SUCCESS (0.099s)
[115.359599] Starting dynamic subtest: xbgr16161616f-4tiled
[115.464108] Dynamic subtest xbgr16161616f-4tiled: SUCCESS (0.110s)
[115.466125] Subtest draw-method-blt: SUCCESS (1.900s)
[115.568174] [029/133] (904s left) kms_cursor_legacy (cursora-vs-flipa-atomic-transitions)
[115.689314] Starting subtest: cursorA-vs-flipA-atomic-transitions
[126.843495] Subtest cursorA-vs-flipA-atomic-transitions: SUCCESS (11.152s)
[127.709888] [030/133] (892s left) kms_cdclk (mode-transition)
[127.816524] Starting subtest: mode-transition
[127.818908] Starting dynamic subtest: pipe-A-eDP-1
[128.103765] Dynamic subtest pipe-A-eDP-1: SKIP (0.287s)
[128.112282] Starting dynamic subtest: pipe-B-eDP-1
[128.116912] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s)
[128.124076] Starting dynamic subtest: pipe-C-eDP-1
[128.128900] Dynamic subtest pipe-C-eDP-1: SKIP (0.001s)
[128.136167] Starting dynamic subtest: pipe-D-eDP-1
[128.140432] Dynamic subtest pipe-D-eDP-1: SKIP (0.001s)
[128.144517] Subtest mode-transition: SKIP (0.294s)
[128.937497] [031/133] (890s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-mmap-cpu)
[129.036484] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-mmap-cpu
[129.040777] Subtest psr-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[129.134385] [032/133] (890s left) gem_exec_fence (invalid-fence-array)
[129.608709] Starting subtest: invalid-fence-array
[129.613916] Subtest invalid-fence-array: SUCCESS (0.002s)
[130.983593] [FACT gem_exec_fence (invalid-fence-array)] new: kernel.kmod_is_loaded.vgem: true
[130.987331] [033/133] (888s left) kms_psr (pr-sprite-plane-move)
[131.079352] Starting subtest: pr-sprite-plane-move
[131.083783] Subtest pr-sprite-plane-move: SKIP (0.000s)
[131.174371] [034/133] (888s left) kms_big_fb (linear-32bpp-rotate-90)
[131.275932] Starting subtest: linear-32bpp-rotate-90
[131.297025] Subtest linear-32bpp-rotate-90: SKIP (0.020s)
[131.407974] [035/133] (888s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-mmap-wc)
[131.508916] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-mmap-wc
[131.513378] Subtest fbc-2p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[131.615716] [036/133] (888s left) kms_atomic_transition (plane-all-modeset-transition)
[131.713107] Starting subtest: plane-all-modeset-transition
[131.717514] Subtest plane-all-modeset-transition: SKIP (0.000s)
[131.783392] [037/133] (888s left) gem_exec_balancer (full-late)
[131.843237] Starting subtest: full-late
[136.753492] Subtest full-late: SUCCESS (4.910s)
[137.078083] [038/133] (883s left) sw_sync (sync_busy_fork)
[137.113710] Starting subtest: sync_busy_fork
[138.123065] Subtest sync_busy_fork: SUCCESS (1.011s)
[138.192796] [039/133] (881s left) kms_psr (fbc-psr2-primary-mmap-cpu)
[138.289078] Starting subtest: fbc-psr2-primary-mmap-cpu
[138.291425] Starting dynamic subtest: eDP-1
[138.295480] Dynamic subtest eDP-1: SKIP (0.000s)
[138.299636] Subtest fbc-psr2-primary-mmap-cpu: SKIP (0.001s)
[138.363501] [040/133] (881s left) kms_joiner (invalid-modeset-force-ultra-joiner)
[138.469975] Starting subtest: invalid-modeset-force-ultra-joiner
[138.474303] Subtest invalid-modeset-force-ultra-joiner: SKIP (0.000s)
[138.534040] [041/133] (881s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-cpu)
[138.640817] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-cpu
[138.645244] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[138.735393] [042/133] (881s left) kms_chamelium_frames (hdmi-crc-nonplanar-formats)
[139.116778] Subtest hdmi-crc-nonplanar-formats: SKIP (0.000s)
[139.957927] [043/133] (880s left) kms_addfb_basic (bad-pitch-256)
[140.020036] Starting subtest: bad-pitch-256
[140.022209] Subtest bad-pitch-256: SUCCESS (0.000s)
[140.173511] [044/133] (880s left) gem_exercise_blt (fast-copy-emit)
[140.231572] Starting subtest: fast-copy-emit
[140.233859] Starting dynamic subtest: linear-smem-smem-emit
[140.254864] Dynamic subtest linear-smem-smem-emit: SUCCESS (0.023s)
[140.264230] Starting dynamic subtest: xmajor-smem-smem-emit
[140.271570] Dynamic subtest xmajor-smem-smem-emit: SUCCESS (0.016s)
[140.278943] Starting dynamic subtest: tile4-smem-smem-emit
[140.288400] Dynamic subtest tile4-smem-smem-emit: SUCCESS (0.016s)
[140.295620] Starting dynamic subtest: tile64-smem-smem-emit
[140.304918] Dynamic subtest tile64-smem-smem-emit: SUCCESS (0.016s)
[140.307210] Subtest fast-copy-emit: SUCCESS (0.073s)
[140.418967] [045/133] (879s left) syncobj_timeline (etime-multi-wait-submitted)
[140.481637] Starting subtest: etime-multi-wait-submitted
[140.586763] Subtest etime-multi-wait-submitted: SUCCESS (0.105s)
[140.666476] [046/133] (879s left) kms_flip_scaled_crc (flip-32bpp-4tile-to-64bpp-4tile-downscaling)
[140.750503] Starting subtest: flip-32bpp-4tile-to-64bpp-4tile-downscaling
[140.752887] Starting dynamic subtest: pipe-A-default-mode
[141.944890] Dynamic subtest pipe-A-default-mode: SKIP (1.193s)
[141.949474] Subtest flip-32bpp-4tile-to-64bpp-4tile-downscaling: SKIP (1.195s)
[142.089255] [047/133] (878s left) gem_exec_reloc (basic-range)
[142.152034] Subtest basic-range: SKIP (0.000s)
[142.231130] [048/133] (878s left) kms_color (ctm-0-50)
[142.319761] Starting subtest: ctm-0-50
[142.321575] Starting dynamic subtest: pipe-A-eDP-1
[145.816800] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.496s)
[145.824890] Starting dynamic subtest: pipe-B-eDP-1
[150.019286] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.203s)
[150.027775] Starting dynamic subtest: pipe-C-eDP-1
[153.953987] Dynamic subtest pipe-C-eDP-1: SUCCESS (3.936s)
[153.962333] Starting dynamic subtest: pipe-D-eDP-1
[157.972716] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.015s)
[157.974644] Subtest ctm-0-50: SUCCESS (15.654s)
[158.793393] [049/133] (861s left) kms_content_protection (dp-mst-lic-type-0-hdcp14)
[158.966213] Starting subtest: dp-mst-lic-type-0-hdcp14
[158.970969] Subtest dp-mst-lic-type-0-hdcp14: SKIP (0.000s)
[159.134661] [050/133] (861s left) kms_atomic (crtc-invalid-params)
[159.240276] Starting subtest: crtc-invalid-params
[159.242635] Starting dynamic subtest: pipe-A-eDP-1
[159.607066] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.365s)
[159.609369] Subtest crtc-invalid-params: SUCCESS (0.367s)
[160.457829] [051/133] (860s left) gem_exec_reloc (basic-concurrent0)
[160.519811] Subtest basic-concurrent0: SKIP (0.000s)
[160.588480] [052/133] (860s left) kms_chamelium_hpd (hdmi-hpd-after-suspend)
[160.967554] Subtest hdmi-hpd-after-suspend: SKIP (0.000s)
[161.740950] [053/133] (859s left) core_auth (getclient-master-drop)
[161.782613] Starting subtest: getclient-master-drop
[161.797349] Subtest getclient-master-drop: SUCCESS (0.017s)
[161.914168] [054/133] (858s left) kms_busy (extended-modeset-hang-newfb)
[162.012106] Starting subtest: extended-modeset-hang-newfb
[162.014486] Starting dynamic subtest: pipe-A
[198.543632] Dynamic subtest pipe-A: SUCCESS (36.533s)
[198.553391] Starting dynamic subtest: pipe-D
[215.780252] Dynamic subtest pipe-D: SUCCESS (17.234s)
[215.782635] Subtest extended-modeset-hang-newfb: SUCCESS (53.771s)
[216.573468] [055/133] (804s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-onoff)
[216.691798] Starting subtest: fbc-2p-scndscrn-spr-indfb-onoff
[216.696208] Subtest fbc-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s)
[216.789858] [056/133] (804s left) gem_ppgtt (shrink-vs-evict-any)
[216.840489] Starting subtest: shrink-vs-evict-any
[222.900852] Subtest shrink-vs-evict-any: SUCCESS (6.058s)
[222.983503] [057/133] (797s left) sw_sync (sync_merge)
[223.022616] Starting subtest: sync_merge
[223.024827] Subtest sync_merge: SUCCESS (0.000s)
[223.070618] [058/133] (797s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-render)
[223.163605] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-render
[230.453908] Subtest psr-1p-primscrn-pri-shrfb-draw-render: SUCCESS (7.293s)
[230.580879] [059/133] (790s left) kms_ccs (random-ccs-data-4-tiled-dg2-rc-ccs)
[230.678182] Starting subtest: random-ccs-data-4-tiled-dg2-rc-ccs
[230.680482] Starting dynamic subtest: pipe-A-eDP-1
[230.704469] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[230.714679] Starting dynamic subtest: pipe-B-eDP-1
[230.737225] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[230.745092] Starting dynamic subtest: pipe-C-eDP-1
[230.767977] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[230.775834] Starting dynamic subtest: pipe-D-eDP-1
[230.798747] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[230.802610] Subtest random-ccs-data-4-tiled-dg2-rc-ccs: SKIP (0.005s)
[232.943904] [060/133] (788s left) gem_exec_schedule (promotion)
[233.021189] Starting subtest: promotion
[233.023077] Starting dynamic subtest: rcs0
[233.122933] Dynamic subtest rcs0: SUCCESS (0.109s)
[233.134990] Starting dynamic subtest: vcs0
[233.217969] Dynamic subtest vcs0: SUCCESS (0.094s)
[233.228443] Starting dynamic subtest: vcs1
[233.302806] Dynamic subtest vcs1: SUCCESS (0.084s)
[233.314223] Starting dynamic subtest: vecs0
[233.382028] Dynamic subtest vecs0: SUCCESS (0.077s)
[233.392489] Starting dynamic subtest: ccs0
[233.475700] Dynamic subtest ccs0: SUCCESS (0.092s)
[233.478461] Subtest promotion: SUCCESS (0.463s)
[234.994051] [061/133] (786s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-mmap-gtt)
[235.083912] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-mmap-gtt
[235.088123] Subtest fbc-1p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[235.196862] [062/133] (785s left) kms_cursor_crc (cursor-sliding-64x64)
[235.473404] Starting subtest: cursor-sliding-64x64
[235.482785] Starting dynamic subtest: pipe-A-eDP-1
[238.727666] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.244s)
[238.759124] Starting dynamic subtest: pipe-D-eDP-1
[242.637383] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.882s)
[242.639325] Subtest cursor-sliding-64x64: SUCCESS (7.162s)
[243.505664] [063/133] (777s left) kms_big_fb (y-tiled-16bpp-rotate-180)
[243.605975] Starting subtest: y-tiled-16bpp-rotate-180
[243.610374] Subtest y-tiled-16bpp-rotate-180: SKIP (0.000s)
[243.700780] [064/133] (777s left) kms_frontbuffer_tracking (psr-rgb565-draw-mmap-wc)
[243.806770] Starting subtest: psr-rgb565-draw-mmap-wc
[250.568064] Subtest psr-rgb565-draw-mmap-wc: SUCCESS (6.765s)
[250.669242] [065/133] (770s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-mmap-cpu)
[250.767615] Starting subtest: psr-2p-primscrn-pri-indfb-draw-mmap-cpu
[250.771771] Subtest psr-2p-primscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[250.866505] [066/133] (770s left) kms_lease (page-flip-implicit-plane)
[250.972177] Starting subtest: page-flip-implicit-plane
[250.974053] Starting dynamic subtest: pipe-A-eDP-1
[251.450902] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.478s)
[251.459651] Starting dynamic subtest: pipe-B-eDP-1
[252.572387] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.121s)
[252.581387] Starting dynamic subtest: pipe-C-eDP-1
[253.682654] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.110s)
[253.693287] Starting dynamic subtest: pipe-D-eDP-1
[254.813427] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.129s)
[254.815756] Subtest page-flip-implicit-plane: SUCCESS (3.844s)
[255.668330] [067/133] (765s left) gem_exec_reloc (basic-wc-read-noreloc)
[255.728974] Subtest basic-wc-read-noreloc: SKIP (0.000s)
[255.793745] [068/133] (765s left) syncobj_wait (invalid-reset-illegal-handle)
[255.848113] Starting subtest: invalid-reset-illegal-handle
[255.850409] Subtest invalid-reset-illegal-handle: SUCCESS (0.000s)
[255.954182] [069/133] (765s left) syncobj_wait (multi-wait-all-submitted)
[256.017303] Starting subtest: multi-wait-all-submitted
[256.123162] Subtest multi-wait-all-submitted: SUCCESS (0.104s)
[256.201709] [070/133] (765s left) kms_pm_rpm (modeset-non-lpsp-stress)
[258.035450] Starting subtest: modeset-non-lpsp-stress
[259.204247] Subtest modeset-non-lpsp-stress: SKIP (1.166s)
[259.584006] [071/133] (761s left) kms_addfb_basic (addfb25-y-tiled-legacy)
[259.681329] Starting subtest: addfb25-y-tiled-legacy
[259.683739] Subtest addfb25-y-tiled-legacy: SUCCESS (0.001s)
[259.807933] [072/133] (761s left) gem_eio (in-flight-internal-10ms)
[260.046553] Starting subtest: in-flight-internal-10ms
[261.988036] Subtest in-flight-internal-10ms: SUCCESS (1.941s)
[262.126651] [073/133] (759s left) gem_eio (execbuf)
[262.345617] Starting subtest: execbuf
[262.671307] Subtest execbuf: SUCCESS (0.327s)
[262.833238] [074/133] (758s left) core_setmaster_vs_auth
[263.000949] [075/133] (758s left) gem_spin_batch (legacy)
[263.049644] Starting subtest: legacy
[263.051943] Starting dynamic subtest: default
[266.290229] Dynamic subtest default: SUCCESS (3.235s)
[266.300434] Starting dynamic subtest: render
[269.528164] Dynamic subtest render: SUCCESS (3.234s)
[269.538323] Starting dynamic subtest: bsd
[272.767745] Dynamic subtest bsd: SUCCESS (3.236s)
[272.779049] Starting dynamic subtest: bsd1
[276.004569] Dynamic subtest bsd1: SUCCESS (3.234s)
[276.016103] Starting dynamic subtest: bsd2
[279.242968] Dynamic subtest bsd2: SUCCESS (3.234s)
[279.252250] Starting dynamic subtest: blt
[282.482174] Dynamic subtest blt: SUCCESS (3.236s)
[282.493397] Starting dynamic subtest: vebox
[285.720245] Dynamic subtest vebox: SUCCESS (3.234s)
[285.722679] Subtest legacy: SUCCESS (22.665s)
[285.919464] [076/133] (735s left) drm_mm (drm_mm)
[285.960216] Starting subtest: drm_mm
[285.990955] Starting dynamic subtest: drm_test_mm_init
[286.084401] Dynamic subtest drm_test_mm_init: SUCCESS (0.093s)
[286.092663] Starting dynamic subtest: drm_test_mm_debug
[286.165014] Dynamic subtest drm_test_mm_debug: SUCCESS (0.078s)
[286.176951] Starting dynamic subtest: drm_test_mm_align32
[286.266233] Dynamic subtest drm_test_mm_align32: SUCCESS (0.102s)
[286.275629] Starting dynamic subtest: drm_test_mm_align64
[286.368933] Dynamic subtest drm_test_mm_align64: SUCCESS (0.103s)
[286.379063] Starting dynamic subtest: drm_test_mm_lowest
[286.463881] Dynamic subtest drm_test_mm_lowest: SUCCESS (0.093s)
[286.473548] Starting dynamic subtest: drm_test_mm_highest
[286.573877] Dynamic subtest drm_test_mm_highest: SUCCESS (0.110s)
[286.576146] Subtest drm_mm: SUCCESS (0.613s)
[286.724607] [077/133] (735s left) gem_ctx_engines (invalid-engines)
[286.791822] Starting subtest: invalid-engines
[286.803679] Subtest invalid-engines: SUCCESS (0.011s)
[287.021917] [078/133] (734s left) gem_ctx_shared (q-promotion)
[287.083186] Starting subtest: Q-promotion
[287.085053] Starting dynamic subtest: rcs0
[287.239648] Dynamic subtest rcs0: SUCCESS (0.157s)
[287.255748] Starting dynamic subtest: vcs0
[287.354936] Dynamic subtest vcs0: SUCCESS (0.116s)
[287.369597] Starting dynamic subtest: vcs1
[287.473249] Dynamic subtest vcs1: SUCCESS (0.116s)
[287.486997] Starting dynamic subtest: vecs0
[287.584578] Dynamic subtest vecs0: SUCCESS (0.112s)
[287.599437] Starting dynamic subtest: ccs0
[287.718088] Dynamic subtest ccs0: SUCCESS (0.131s)
[287.720668] Subtest Q-promotion: SUCCESS (0.637s)
[289.000567] [079/133] (732s left) kms_addfb_basic (clobberred-modifier)
[289.059560] Starting subtest: clobberred-modifier
[289.063872] Subtest clobberred-modifier: SKIP (0.000s)
[289.190339] [080/133] (732s left) gem_userptr_blits (sync-unmap-cycles)
[289.260297] Starting subtest: sync-unmap-cycles
[294.633888] Subtest sync-unmap-cycles: SUCCESS (5.374s)
[294.761616] [081/133] (727s left) gem_sync (basic-many-each)
[294.847753] Starting subtest: basic-many-each
[297.165210] Subtest basic-many-each: SUCCESS (2.323s)
[297.350411] [082/133] (724s left) i915_drm_fdinfo (idle)
[297.386763] Starting subtest: idle
[297.388926] Starting dynamic subtest: rcs0
[297.949833] Dynamic subtest rcs0: SUCCESS (0.564s)
[297.963766] Starting dynamic subtest: bcs0
[298.457853] Dynamic subtest bcs0: SUCCESS (0.504s)
[298.473672] Starting dynamic subtest: vcs0
[298.964131] Dynamic subtest vcs0: SUCCESS (0.503s)
[298.974334] Starting dynamic subtest: vcs1
[299.469440] Dynamic subtest vcs1: SUCCESS (0.503s)
[299.480286] Starting dynamic subtest: vecs0
[299.975914] Dynamic subtest vecs0: SUCCESS (0.503s)
[299.987743] Starting dynamic subtest: ccs0
[300.481585] Dynamic subtest ccs0: SUCCESS (0.503s)
[300.484740] Subtest idle: SUCCESS (3.095s)
[300.568100] [083/133] (721s left) kms_plane (pixel-format-4-tiled-bmg-ccs-modifier)
[300.665074] Starting subtest: pixel-format-4-tiled-bmg-ccs-modifier
[300.669572] Subtest pixel-format-4-tiled-bmg-ccs-modifier: SKIP (0.000s)
[300.738227] [084/133] (721s left) gem_exec_balancer (parallel-keep-in-fence)
[300.997485] Starting subtest: parallel-keep-in-fence
[302.106901] Subtest parallel-keep-in-fence: SUCCESS (1.113s)
[302.234050] [085/133] (719s left) api_intel_allocator (open-vm)
[302.282778] Starting subtest: open-vm
[302.284735] Subtest open-vm: SUCCESS (0.004s)
[302.414278] [086/133] (719s left) kms_plane (pixel-format-yf-tiled-ccs-modifier-source-clamping)
[302.502151] Starting subtest: pixel-format-yf-tiled-ccs-modifier-source-clamping
[302.506597] Subtest pixel-format-yf-tiled-ccs-modifier-source-clamping: SKIP (0.000s)
[302.572303] [087/133] (719s left) sw_sync (alloc_timeline)
[302.608082] Starting subtest: alloc_timeline
[302.609967] Subtest alloc_timeline: SUCCESS (0.000s)
[302.662091] [088/133] (719s left) gem_pread (display)
[302.713837] Subtest display: SKIP (0.000s)
[302.774919] [089/133] (719s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-plflip-blt)
[302.883906] Starting subtest: fbcpsr-1p-primscrn-indfb-plflip-blt
[310.353775] Subtest fbcpsr-1p-primscrn-indfb-plflip-blt: SUCCESS (7.471s)
[310.487102] [090/133] (711s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-shrfb-pgflip-blt)
[310.596952] Starting subtest: fbcpsr-2p-primscrn-shrfb-pgflip-blt
[310.600987] Subtest fbcpsr-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[310.680573] [091/133] (711s left) kms_psr (fbc-psr-primary-page-flip)
[310.774283] Starting subtest: fbc-psr-primary-page-flip
[310.776373] Starting dynamic subtest: eDP-1
[310.780177] Dynamic subtest eDP-1: SKIP (0.000s)
[310.784112] Subtest fbc-psr-primary-page-flip: SKIP (0.001s)
[310.878824] [092/133] (711s left) kms_rotation_crc (primary-rotation-270)
[310.977292] Starting subtest: primary-rotation-270
[310.981644] Subtest primary-rotation-270: SKIP (0.001s)
[311.064297] [093/133] (711s left) kms_cursor_legacy (cursorb-vs-flipa-atomic-transitions)
[311.181709] Starting subtest: cursorB-vs-flipA-atomic-transitions
[311.186115] Subtest cursorB-vs-flipA-atomic-transitions: SKIP (0.001s)
[311.324199] [094/133] (711s left) kms_ccs (bad-rotation-90-4-tiled-lnl-ccs)
[311.423228] Starting subtest: bad-rotation-90-4-tiled-lnl-ccs
[311.426820] Subtest bad-rotation-90-4-tiled-lnl-ccs: SKIP (0.000s)
[312.523949] [095/133] (710s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-blt)
[312.628412] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-blt
[316.781631] Subtest fbc-1p-offscreen-pri-shrfb-draw-blt: SUCCESS (4.157s)
[317.926214] [096/133] (704s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180-hflip)
[318.027150] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180-hflip
[318.031744] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180-hflip: SKIP (0.000s)
[318.125238] [097/133] (704s left) gem_ctx_persistence (heartbeat-stop)
[318.194753] Starting subtest: heartbeat-stop
[318.199442] Subtest heartbeat-stop: SKIP (0.000s)
[318.301741] [098/133] (704s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-pwrite)
[318.397694] Starting subtest: psr-1p-primscrn-pri-indfb-draw-pwrite
[326.066748] Subtest psr-1p-primscrn-pri-indfb-draw-pwrite: SUCCESS (7.671s)
[326.168804] [099/133] (696s left) kms_pm_rpm (dpms-lpsp)
[328.009431] Starting subtest: dpms-lpsp
[328.394025] Subtest dpms-lpsp: SUCCESS (0.386s)
[328.483826] [100/133] (694s left) sysfs_timeslice_duration (idempotent)
[328.543539] Starting subtest: idempotent
[328.546048] Starting dynamic subtest: vecs0
[328.548428] Dynamic subtest vecs0: SUCCESS (0.000s)
[328.559269] Starting dynamic subtest: ccs0
[328.561516] Dynamic subtest ccs0: SUCCESS (0.000s)
[328.572062] Starting dynamic subtest: vcs0
[328.574331] Dynamic subtest vcs0: SUCCESS (0.000s)
[328.582703] Starting dynamic subtest: bcs0
[328.585038] Dynamic subtest bcs0: SUCCESS (0.000s)
[328.593265] Starting dynamic subtest: rcs0
[328.595560] Dynamic subtest rcs0: SUCCESS (0.000s)
[328.604234] Starting dynamic subtest: vcs1
[328.606226] Dynamic subtest vcs1: SUCCESS (0.000s)
[328.608167] Subtest idempotent: SUCCESS (0.006s)
[328.655849] [101/133] (694s left) kms_psr (psr-primary-blt)
[328.742588] Starting subtest: psr-primary-blt
[328.744918] Starting dynamic subtest: eDP-1
[330.451812] Dynamic subtest eDP-1: SUCCESS (1.709s)
[330.454636] Subtest psr-primary-blt: SUCCESS (1.711s)
[331.314571] [102/133] (691s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-draw-mmap-gtt)
[331.410240] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-draw-mmap-gtt
[331.414181] Subtest fbcpsr-2p-primscrn-cur-indfb-draw-mmap-gtt: SKIP (0.000s)
[331.502435] [103/133] (691s left) gem_exec_reloc (basic-wc-cpu)
[331.552866] Subtest basic-wc-cpu: SKIP (0.000s)
[331.644073] [104/133] (691s left) perf_pmu (render-node-busy)
[331.714016] Starting subtest: render-node-busy
[331.716436] Starting dynamic subtest: rcs0
[332.303612] Dynamic subtest rcs0: SUCCESS (0.589s)
[332.314997] Starting dynamic subtest: bcs0
[332.871058] Dynamic subtest bcs0: SUCCESS (0.565s)
[332.882985] Starting dynamic subtest: vcs0
[334.935749] Dynamic subtest vcs0: SUCCESS (2.060s)
[334.947815] Starting dynamic subtest: vcs1
[336.919198] Dynamic subtest vcs1: SUCCESS (1.980s)
[336.930841] Starting dynamic subtest: vecs0
[338.900862] Dynamic subtest vecs0: SUCCESS (1.980s)
[338.909653] Starting dynamic subtest: ccs0
[339.468947] Dynamic subtest ccs0: SUCCESS (0.567s)
[339.471446] Subtest render-node-busy: SUCCESS (7.756s)
[339.547820] [105/133] (683s left) kms_ccs (crc-primary-basic-4-tiled-lnl-ccs)
[339.644054] Starting subtest: crc-primary-basic-4-tiled-lnl-ccs
[339.648678] Subtest crc-primary-basic-4-tiled-lnl-ccs: SKIP (0.000s)
[340.742266] [106/133] (682s left) syncobj_timeline (single-wait-signaled)
[340.794383] Starting subtest: single-wait-signaled
[340.796759] Subtest single-wait-signaled: SUCCESS (0.000s)
[340.893365] [107/133] (682s left) kms_frontbuffer_tracking (fbc-modesetfrombusy)
[340.993517] Starting subtest: fbc-modesetfrombusy
[344.691982] Subtest fbc-modesetfrombusy: SUCCESS (3.702s)
[345.873754] [108/133] (677s left) gen7_exec_parse (oacontrol-tracking)
[345.942633] Subtest oacontrol-tracking: SKIP (0.000s)
[346.016813] [109/133] (677s left) kms_pipe_crc_basic (compare-crc-sanitycheck-nv12)
[346.106224] Starting subtest: compare-crc-sanitycheck-nv12
[346.108475] Starting dynamic subtest: pipe-A-eDP-1
[346.770081] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.665s)
[346.779987] Starting dynamic subtest: pipe-B-eDP-1
[347.995950] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.224s)
[348.006891] Starting dynamic subtest: pipe-C-eDP-1
[349.208676] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.211s)
[349.218258] Starting dynamic subtest: pipe-D-eDP-1
[350.449144] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.238s)
[350.451453] Subtest compare-crc-sanitycheck-nv12: SUCCESS (4.344s)
[351.284195] [110/133] (671s left) kms_big_fb (4-tiled-8bpp-rotate-90)
[351.387792] Starting subtest: 4-tiled-8bpp-rotate-90
[351.409374] Subtest 4-tiled-8bpp-rotate-90: SKIP (0.021s)
[351.534249] [111/133] (671s left) kms_flip (flip-vs-rmfb)
[351.627620] Starting subtest: flip-vs-rmfb
[351.630018] Starting dynamic subtest: A-eDP1
[360.256553] Dynamic subtest A-eDP1: SUCCESS (8.631s)
[360.269045] Starting dynamic subtest: B-eDP1
[368.897596] Dynamic subtest B-eDP1: SUCCESS (8.637s)
[368.913074] Starting dynamic subtest: C-eDP1
[377.517870] Dynamic subtest C-eDP1: SUCCESS (8.617s)
[377.529854] Starting dynamic subtest: D-eDP1
[386.158124] Dynamic subtest D-eDP1: SUCCESS (8.637s)
[386.164172] Subtest flip-vs-rmfb: SUCCESS (34.539s)
[387.338713] [112/133] (635s left) gem_exec_whisper (basic-fds-priority)
[387.417132] Starting subtest: basic-fds-priority
[412.312206] Subtest basic-fds-priority: SUCCESS (24.891s)
[412.503031] [113/133] (610s left) kms_ccs (crc-primary-suspend-4-tiled-mtl-rc-ccs)
[412.599229] Starting subtest: crc-primary-suspend-4-tiled-mtl-rc-ccs
[412.601107] Starting dynamic subtest: pipe-A-eDP-1
[429.268450] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.552s)
[429.278981] Starting dynamic subtest: pipe-B-eDP-1
[446.239424] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.446s)
[446.250565] Starting dynamic subtest: pipe-C-eDP-1
[463.248554] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.366s)
[463.259689] Starting dynamic subtest: pipe-D-eDP-1
[480.211437] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.353s)
[480.213908] Subtest crc-primary-suspend-4-tiled-mtl-rc-ccs: SUCCESS (8.722s)
[481.366069] [114/133] (541s left) syncobj_timeline (32bits-limit)
[481.430549] Starting subtest: 32bits-limit
[481.433476] Subtest 32bits-limit: SUCCESS (0.001s)
[481.549885] [115/133] (541s left) i915_module_load (reload-no-display)
[481.588408] Starting subtest: reload-no-display
[486.934015] Subtest reload-no-display: SUCCESS (5.313s)
[486.982771] [FACT i915_module_load (reload-no-display)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[486.983463] [FACT i915_module_load (reload-no-display)] deleted: kernel.kmod_is_loaded.i915: true
[486.987168] [116/133] (536s left) gem_mmap_gtt (big-bo-tiledx)
[489.484248] Subtest big-bo-tiledX: SKIP (0.000s)
[489.553874] [FACT gem_mmap_gtt (big-bo-tiledx)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[489.555165] [FACT gem_mmap_gtt (big-bo-tiledx)] new: kernel.kmod_is_loaded.i915: true
[489.559286] [117/133] (533s left) kms_flip (2x-flip-vs-dpms-off-vs-modeset-interruptible)
[489.655549] Starting subtest: 2x-flip-vs-dpms-off-vs-modeset-interruptible
[489.665993] Subtest 2x-flip-vs-dpms-off-vs-modeset-interruptible: SKIP (0.010s)
[489.746836] [118/133] (533s left) kms_flip (2x-wf_vblank-ts-check-interruptible)
[489.844047] Starting subtest: 2x-wf_vblank-ts-check-interruptible
[489.855363] Subtest 2x-wf_vblank-ts-check-interruptible: SKIP (0.010s)
[489.953168] [119/133] (533s left) i915_pm_rpm (gem-execbuf-stress)
[491.897317] Starting subtest: gem-execbuf-stress
[491.900517] Starting dynamic subtest: smem0
[507.516203] Dynamic subtest smem0: SUCCESS (15.599s)
[507.527926] Starting dynamic subtest: extra-wait-smem0
[569.912661] Dynamic subtest extra-wait-smem0: SUCCESS (62.379s)
[569.915658] Subtest gem-execbuf-stress: SUCCESS (77.984s)
[570.294959] [120/133] (453s left) gem_mmap_gtt (basic-write-read-distinct)
[570.353226] Subtest basic-write-read-distinct: SKIP (0.000s)
[570.409581] [121/133] (453s left) kms_flip (2x-modeset-vs-vblank-race-interruptible)
[570.506905] Starting subtest: 2x-modeset-vs-vblank-race-interruptible
[570.518563] Subtest 2x-modeset-vs-vblank-race-interruptible: SKIP (0.011s)
[570.601152] [122/133] (453s left) gem_render_copy (y-tiled-ccs-to-yf-tiled-ccs)
[570.662387] Starting subtest: y-tiled-ccs-to-yf-tiled-ccs
[570.668439] Subtest y-tiled-ccs-to-yf-tiled-ccs: SKIP (0.000s)
[570.859131] [123/133] (452s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-indfb-pgflip-blt)
[570.962550] Starting subtest: fbcpsr-2p-scndscrn-indfb-pgflip-blt
[570.967512] Subtest fbcpsr-2p-scndscrn-indfb-pgflip-blt: SKIP (0.000s)
[571.057057] [124/133] (452s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-16bpp-ytile-downscaling)
[571.141422] Starting subtest: flip-64bpp-ytile-to-16bpp-ytile-downscaling
[571.146673] Subtest flip-64bpp-ytile-to-16bpp-ytile-downscaling: SKIP (0.000s)
[571.222959] [125/133] (452s left) kms_frontbuffer_tracking (fbcpsr-farfromfence-mmap-gtt)
[571.315282] Starting subtest: fbcpsr-farfromfence-mmap-gtt
[571.320607] Subtest fbcpsr-farfromfence-mmap-gtt: SKIP (0.000s)
[571.407204] [126/133] (452s left) kms_plane (plane-position-hole-dpms)
[571.492668] Starting subtest: plane-position-hole-dpms
[572.061123] Starting dynamic subtest: pipe-A-plane-1
[574.451955] Dynamic subtest pipe-A-plane-1: SUCCESS (2.392s)
[574.462033] Starting dynamic subtest: pipe-A-plane-2
[576.819467] Dynamic subtest pipe-A-plane-2: SUCCESS (2.364s)
[576.829741] Starting dynamic subtest: pipe-A-plane-3
[579.170165] Dynamic subtest pipe-A-plane-3: SUCCESS (2.351s)
[579.180124] Starting dynamic subtest: pipe-A-plane-4
[581.548979] Dynamic subtest pipe-A-plane-4: SUCCESS (2.379s)
[581.566576] Starting dynamic subtest: pipe-A-plane-5
[581.578361] Dynamic subtest pipe-A-plane-5: SUCCESS (0.026s)
[582.729588] Starting dynamic subtest: pipe-B-plane-1
[585.136572] Dynamic subtest pipe-B-plane-1: SUCCESS (2.414s)
[585.146668] Starting dynamic subtest: pipe-B-plane-2
[587.500560] Dynamic subtest pipe-B-plane-2: SUCCESS (2.362s)
[587.510247] Starting dynamic subtest: pipe-B-plane-3
[589.874816] Dynamic subtest pipe-B-plane-3: SUCCESS (2.373s)
[589.884734] Starting dynamic subtest: pipe-B-plane-4
[592.249196] Dynamic subtest pipe-B-plane-4: SUCCESS (2.374s)
[592.259565] Starting dynamic subtest: pipe-B-plane-5
[592.275459] Dynamic subtest pipe-B-plane-5: SUCCESS (0.026s)
[592.278070] Subtest plane-position-hole-dpms: SUCCESS (20.786s)
[593.054162] [127/133] (430s left) kms_psr (fbc-pr-primary-mmap-gtt)
[593.143654] Starting subtest: fbc-pr-primary-mmap-gtt
[593.149678] Subtest fbc-pr-primary-mmap-gtt: SKIP (0.000s)
[593.215796] [128/133] (430s left) tools_test (sysfs_l3_parity)
[593.271837] Starting subtest: sysfs_l3_parity
[593.321919] Subtest sysfs_l3_parity: SKIP (0.065s)
[593.377942] [129/133] (430s left) gem_ctx_exec (basic-nohangcheck)
[593.424473] Starting subtest: basic-nohangcheck
[593.657650] Subtest basic-nohangcheck: SUCCESS (0.235s)
[593.772199] [130/133] (430s left) kms_flip (basic-flip-vs-dpms)
[593.866976] Starting subtest: basic-flip-vs-dpms
[593.869540] Starting dynamic subtest: A-eDP1
[596.441460] Dynamic subtest A-eDP1: SUCCESS (2.577s)
[596.451680] Starting dynamic subtest: B-eDP1
[598.598566] Dynamic subtest B-eDP1: SUCCESS (2.153s)
[598.608418] Starting dynamic subtest: C-eDP1
[600.762868] Dynamic subtest C-eDP1: SUCCESS (2.164s)
[600.773202] Starting dynamic subtest: D-eDP1
[602.814334] Dynamic subtest D-eDP1: SUCCESS (2.050s)
[602.817294] Subtest basic-flip-vs-dpms: SUCCESS (8.955s)
[603.617008] [131/133] (420s left) kms_cursor_legacy (basic-flip-before-cursor-atomic)
[603.757073] Starting subtest: basic-flip-before-cursor-atomic
[604.676530] Subtest basic-flip-before-cursor-atomic: SUCCESS (0.921s)
[605.536545] [132/133] (418s left) gem_mmap_wc (read-write)
[605.593079] Subtest read-write: SKIP (0.000s)
[605.662257] [133/133] (418s left) kms_vblank (wait-idle-hang)
[605.750596] Starting subtest: wait-idle-hang
[605.753101] Starting dynamic subtest: pipe-A-eDP-1
[612.045566] Dynamic subtest pipe-A-eDP-1: SUCCESS (6.294s)
[612.061676] Starting dynamic subtest: pipe-D-eDP-1
[618.061666] Dynamic subtest pipe-D-eDP-1: SUCCESS (6.013s)
[618.064536] Subtest wait-idle-hang: SUCCESS (12.312s)
[618.890372] Closing watchdogs
results: parsing output: 0/ for test: gem_softpin
results: parsing output: 1/ for test: kms_panel_fitting
results: parsing output: 2/ for test: gem_lmem_swapping
results: parsing output: 3/ for test: gem_blits
results: parsing output: 4/ for test: kms_dp_linktrain_fallback
results: parsing output: 5/ for test: kms_pm_backlight
results: parsing output: 6/ for test: kms_psr2_sf
results: parsing output: 7/ for test: kms_cursor_crc
results: parsing output: 8/ for test: kms_frontbuffer_tracking
results: parsing output: 9/ for test: kms_psr
results: parsing output: 10/ for test: perf
results: parsing output: 11/ for test: kms_getfb
results: parsing output: 12/ for test: prime_self_import
results: parsing output: 13/ for test: kms_big_fb
results: parsing output: 14/ for test: kms_psr2_sf
results: parsing output: 15/ for test: kms_cursor_crc
results: parsing output: 16/ for test: syncobj_timeline
results: parsing output: 17/ for test: syncobj_eventfd
results: parsing output: 18/ for test: kms_selftest
results: parsing output: 19/ for test: i915_pm_rps
results: parsing output: 20/ for test: syncobj_timeline
results: parsing output: 21/ for test: gem_render_copy
results: parsing output: 22/ for test: gem_exec_schedule
results: parsing output: 23/ for test: syncobj_wait
results: parsing output: 24/ for test: gem_mmap_offset
results: parsing output: 25/ for test: gem_userptr_blits
results: parsing output: 26/ for test: kms_big_fb
results: parsing output: 27/ for test: kms_draw_crc
results: parsing output: 28/ for test: kms_cursor_legacy
results: parsing output: 29/ for test: kms_cdclk
results: parsing output: 30/ for test: kms_frontbuffer_tracking
results: parsing output: 31/ for test: gem_exec_fence
results: parsing output: 32/ for test: kms_psr
results: parsing output: 33/ for test: kms_big_fb
results: parsing output: 34/ for test: kms_frontbuffer_tracking
results: parsing output: 35/ for test: kms_atomic_transition
results: parsing output: 36/ for test: gem_exec_balancer
results: parsing output: 37/ for test: sw_sync
results: parsing output: 38/ for test: kms_psr
results: parsing output: 39/ for test: kms_joiner
results: parsing output: 40/ for test: kms_frontbuffer_tracking
results: parsing output: 41/ for test: kms_chamelium_frames
results: parsing output: 42/ for test: kms_addfb_basic
results: parsing output: 43/ for test: gem_exercise_blt
results: parsing output: 44/ for test: syncobj_timeline
results: parsing output: 45/ for test: kms_flip_scaled_crc
results: parsing output: 46/ for test: gem_exec_reloc
results: parsing output: 47/ for test: kms_color
results: parsing output: 48/ for test: kms_content_protection
results: parsing output: 49/ for test: kms_atomic
results: parsing output: 50/ for test: gem_exec_reloc
results: parsing output: 51/ for test: kms_chamelium_hpd
results: parsing output: 52/ for test: core_auth
results: parsing output: 53/ for test: kms_busy
results: parsing output: 54/ for test: kms_frontbuffer_tracking
results: parsing output: 55/ for test: gem_ppgtt
results: parsing output: 56/ for test: sw_sync
results: parsing output: 57/ for test: kms_frontbuffer_tracking
results: parsing output: 58/ for test: kms_ccs
results: parsing output: 59/ for test: gem_exec_schedule
results: parsing output: 60/ for test: kms_frontbuffer_tracking
results: parsing output: 61/ for test: kms_cursor_crc
results: parsing output: 62/ for test: kms_big_fb
results: parsing output: 63/ for test: kms_frontbuffer_tracking
results: parsing output: 64/ for test: kms_frontbuffer_tracking
results: parsing output: 65/ for test: kms_lease
results: parsing output: 66/ for test: gem_exec_reloc
results: parsing output: 67/ for test: syncobj_wait
results: parsing output: 68/ for test: syncobj_wait
results: parsing output: 69/ for test: kms_pm_rpm
results: parsing output: 70/ for test: kms_addfb_basic
results: parsing output: 71/ for test: gem_eio
results: parsing output: 72/ for test: gem_eio
results: parsing output: 73/ for test: core_setmaster_vs_auth
results: parsing output: 74/ for test: gem_spin_batch
results: parsing output: 75/ for test: drm_mm
results: parsing output: 76/ for test: gem_ctx_engines
results: parsing output: 77/ for test: gem_ctx_shared
results: parsing output: 78/ for test: kms_addfb_basic
results: parsing output: 79/ for test: gem_userptr_blits
results: parsing output: 80/ for test: gem_sync
results: parsing output: 81/ for test: i915_drm_fdinfo
results: parsing output: 82/ for test: kms_plane
results: parsing output: 83/ for test: gem_exec_balancer
results: parsing output: 84/ for test: api_intel_allocator
results: parsing output: 85/ for test: kms_plane
results: parsing output: 86/ for test: sw_sync
results: parsing output: 87/ for test: gem_pread
results: parsing output: 88/ for test: kms_frontbuffer_tracking
results: parsing output: 89/ for test: kms_frontbuffer_tracking
results: parsing output: 90/ for test: kms_psr
results: parsing output: 91/ for test: kms_rotation_crc
results: parsing output: 92/ for test: kms_cursor_legacy
results: parsing output: 93/ for test: kms_ccs
results: parsing output: 94/ for test: kms_frontbuffer_tracking
results: parsing output: 95/ for test: kms_big_fb
results: parsing output: 96/ for test: gem_ctx_persistence
results: parsing output: 97/ for test: kms_frontbuffer_tracking
results: parsing output: 98/ for test: kms_pm_rpm
results: parsing output: 99/ for test: sysfs_timeslice_duration
results: parsing output: 100/ for test: kms_psr
results: parsing output: 101/ for test: kms_frontbuffer_tracking
results: parsing output: 102/ for test: gem_exec_reloc
results: parsing output: 103/ for test: perf_pmu
results: parsing output: 104/ for test: kms_ccs
results: parsing output: 105/ for test: syncobj_timeline
results: parsing output: 106/ for test: kms_frontbuffer_tracking
results: parsing output: 107/ for test: gen7_exec_parse
results: parsing output: 108/ for test: kms_pipe_crc_basic
results: parsing output: 109/ for test: kms_big_fb
results: parsing output: 110/ for test: kms_flip
results: parsing output: 111/ for test: gem_exec_whisper
results: parsing output: 112/ for test: kms_ccs
results: parsing output: 113/ for test: syncobj_timeline
results: parsing output: 114/ for test: i915_module_load
results: parsing output: 115/ for test: gem_mmap_gtt
results: parsing output: 116/ for test: kms_flip
results: parsing output: 117/ for test: kms_flip
results: parsing output: 118/ for test: i915_pm_rpm
results: parsing output: 119/ for test: gem_mmap_gtt
results: parsing output: 120/ for test: kms_flip
results: parsing output: 121/ for test: gem_render_copy
results: parsing output: 122/ for test: kms_frontbuffer_tracking
results: parsing output: 123/ for test: kms_flip_scaled_crc
results: parsing output: 124/ for test: kms_frontbuffer_tracking
results: parsing output: 125/ for test: kms_plane
results: parsing output: 126/ for test: kms_psr
results: parsing output: 127/ for test: tools_test
results: parsing output: 128/ for test: gem_ctx_exec
results: parsing output: 129/ for test: kms_flip
results: parsing output: 130/ for test: kms_cursor_legacy
results: parsing output: 131/ for test: gem_mmap_wc
results: parsing output: 132/ for test: kms_vblank
Done.