[73.485964] Initializing watchdogs
[73.486193]   /dev/watchdog0
[73.511539] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:0102 Intel Sandybridge (Gen6) 2nd Generation Core Processor Family Integrated Graphics Controller (XPS 8300)
[73.519459] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[73.523309] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[73.526603] [001/130] (960s left) kms_psr (psr-cursor-render)
[73.893243] Subtest psr-cursor-render: SKIP (0.000s)
[74.122932] [002/130] (959s left) i915_pm_rpm (sysfs-read)
[75.734400] Subtest sysfs-read: SKIP (0.000s)
[75.947643] [003/130] (958s left) kms_rotation_crc (multiplane-rotation-cropping-top)
[76.304589] Starting subtest: multiplane-rotation-cropping-top
[76.307013] Subtest multiplane-rotation-cropping-top: SKIP (0.000s)
[76.736661] [004/130] (957s left) gen9_exec_parse (shadow-peek)
[76.803840] Subtest shadow-peek: SKIP (0.000s)
[76.867778] [005/130] (957s left) kms_pm_rpm (modeset-lpsp-stress)
[78.428364] Subtest modeset-lpsp-stress: SKIP (0.000s)
[78.645254] [006/130] (955s left) kms_plane_alpha_blend (alpha-transparent-fb)
[79.005457] Starting subtest: alpha-transparent-fb
[79.166494] Subtest alpha-transparent-fb: SKIP (0.161s)
[79.819435] [007/130] (954s left) gem_exec_gttfill (basic)
[79.887495] Starting subtest: basic
[83.574918] Subtest basic: SUCCESS (3.687s)
[83.807551] [008/130] (950s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-cpu)
[84.261438] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-cpu
[84.263508] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[84.738237] [009/130] (949s left) kms_flip (absolute-wf_vblank-interruptible)
[85.095849] Starting subtest: absolute-wf_vblank-interruptible
[85.097107] Starting dynamic subtest: A-VGA1
[92.912155] Dynamic subtest A-VGA1: SUCCESS (7.815s)
[92.923437] Starting dynamic subtest: B-VGA1
[100.617394] Dynamic subtest B-VGA1: SUCCESS (7.704s)
[100.630339] Starting dynamic subtest: A-HDMI-A1
[108.491400] Dynamic subtest A-HDMI-A1: SUCCESS (7.873s)
[108.501872] Starting dynamic subtest: B-HDMI-A1
[116.394292] Dynamic subtest B-HDMI-A1: SUCCESS (7.901s)
[116.395465] Subtest absolute-wf_vblank-interruptible: SUCCESS (31.300s)
[117.026243] [010/130] (917s left) gem_exec_fence (syncobj-repeat)
[117.268051] Starting subtest: syncobj-repeat
[117.706177] Subtest syncobj-repeat: SUCCESS (0.437s)
[118.060322] [FACT gem_exec_fence (syncobj-repeat)] new: kernel.kmod_is_loaded.vgem: true
[118.063549] [011/130] (916s left) gen9_exec_parse (allowed-single)
[118.121291] Subtest allowed-single: SKIP (0.000s)
[118.173376] [012/130] (916s left) gem_exec_reloc (basic-wc-cpu-noreloc)
[118.237573] Starting subtest: basic-wc-cpu-noreloc
[118.239749] Subtest basic-wc-cpu-noreloc: SUCCESS (0.002s)
[118.976763] [013/130] (915s left) kms_rmfb (close-fd)
[119.341211] Starting subtest: close-fd
[119.342307] Starting dynamic subtest: pipe-A-HDMI-A-1
[119.449750] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.109s)
[119.459788] Starting dynamic subtest: pipe-B-HDMI-A-1
[119.722586] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.272s)
[119.723701] Subtest close-fd: SUCCESS (0.384s)
[120.390871] [014/130] (914s left) gem_mmap_wc (pf-nonblock)
[120.447460] Starting subtest: pf-nonblock
[120.448442] Subtest pf-nonblock: SUCCESS (0.001s)
[120.605443] [015/130] (914s left) kms_ccs (bad-rotation-90-4-tiled-mtl-mc-ccs)
[120.664291] Subtest bad-rotation-90-4-tiled-mtl-mc-ccs: SKIP (0.000s)
[120.719799] [016/130] (914s left) kms_flip (2x-dpms-vs-vblank-race-interruptible)
[121.086153] Starting subtest: 2x-dpms-vs-vblank-race-interruptible
[121.087263] Starting dynamic subtest: AB-VGA1-HDMI-A1
[131.769544] Dynamic subtest AB-VGA1-HDMI-A1: SUCCESS (10.682s)
[131.770538] Subtest 2x-dpms-vs-vblank-race-interruptible: SUCCESS (10.685s)
[132.356822] [017/130] (902s left) gem_exec_balancer (noheartbeat)
[132.429389] Subtest noheartbeat: SKIP (0.000s)
[132.536926] [018/130] (902s left) kms_frontbuffer_tracking (fbc-2p-primscrn-indfb-msflip-blt)
[132.899987] Starting subtest: fbc-2p-primscrn-indfb-msflip-blt
[132.902096] Subtest fbc-2p-primscrn-indfb-msflip-blt: SKIP (0.000s)
[133.367961] [019/130] (901s left) gem_exec_balancer (parallel-out-fence)
[133.425238] Subtest parallel-out-fence: SKIP (0.000s)
[133.548429] [020/130] (901s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-indfb-msflip-blt)
[133.912584] Starting subtest: fbcpsr-2p-scndscrn-indfb-msflip-blt
[133.914767] Subtest fbcpsr-2p-scndscrn-indfb-msflip-blt: SKIP (0.000s)
[134.386481] [021/130] (900s left) kms_frontbuffer_tracking (fbc-rgb565-draw-render)
[134.749349] Starting subtest: fbc-rgb565-draw-render
[136.627656] Subtest fbc-rgb565-draw-render: SUCCESS (1.879s)
[137.132411] [022/130] (897s left) kms_psr2_sf (pr-primary-plane-update-sf-dmg-area-big-fb)
[137.490776] Subtest pr-primary-plane-update-sf-dmg-area-big-fb: SKIP (0.000s)
[137.721866] [023/130] (897s left) kms_atomic_transition (plane-all-transition-nonblocking)
[138.075953] Starting subtest: plane-all-transition-nonblocking
[138.077115] Starting dynamic subtest: pipe-A-HDMI-A-1
[139.239773] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (1.161s)
[139.333278] Starting dynamic subtest: pipe-B-HDMI-A-1
[140.650256] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (1.325s)
[140.733360] Subtest plane-all-transition-nonblocking: SUCCESS (2.658s)
[141.317767] [024/130] (893s left) kms_cursor_edge_walk (64x64-left-edge)
[141.676191] Starting subtest: 64x64-left-edge
[141.677241] Starting dynamic subtest: pipe-A-HDMI-A-1
[145.110350] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (3.433s)
[145.123192] Starting dynamic subtest: pipe-B-HDMI-A-1
[148.439408] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (3.327s)
[148.440525] Subtest 64x64-left-edge: SUCCESS (6.765s)
[149.016281] [025/130] (886s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-rc-ccs)
[149.073428] Subtest crc-primary-suspend-4-tiled-dg2-rc-ccs: SKIP (0.000s)
[149.136222] [026/130] (886s left) gem_exec_reloc (basic-wc-cpu-active)
[149.195339] Starting subtest: basic-wc-cpu-active
[149.305819] Subtest basic-wc-cpu-active: SUCCESS (0.110s)
[150.068753] [027/130] (885s left) syncobj_timeline (multi-wait-for-submit-signaled)
[150.125901] Starting subtest: multi-wait-for-submit-signaled
[150.128246] Subtest multi-wait-for-submit-signaled: SUCCESS (0.001s)
[150.250745] [028/130] (885s left) gem_lmem_swapping (random)
[150.308568] Subtest random: SKIP (0.000s)
[150.362343] [029/130] (885s left) kms_vrr (flip-basic)
[150.723909] Starting subtest: flip-basic
[150.727183] Subtest flip-basic: SKIP (0.000s)
[151.182658] [030/130] (884s left) perf (stress-open-close)
[151.339181] Subtest stress-open-close: SKIP (0.000s)
[151.394414] [031/130] (884s left) fbdev (info)
[151.447600] Starting subtest: info
[151.448908] Subtest info: SUCCESS (0.000s)
[151.579294] [032/130] (884s left) api_intel_allocator (execbuf-with-allocator)
[151.635838] Starting subtest: execbuf-with-allocator
[151.638089] Subtest execbuf-with-allocator: SKIP (0.000s)
[151.763028] [033/130] (883s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytile-downscaling)
[151.820112] Subtest flip-64bpp-ytile-to-32bpp-ytile-downscaling: SKIP (0.000s)
[151.880809] [034/130] (883s left) dmabuf_sync_file (export-multiwait)
[151.948939] Starting subtest: export-multiwait
[151.950049] Subtest export-multiwait: SUCCESS (0.002s)
[152.062191] [035/130] (883s left) perf_pmu (invalid-open)
[152.120728] Starting subtest: invalid-open
[152.121863] Subtest invalid-open: SUCCESS (0.000s)
[152.251606] [036/130] (883s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-pwrite)
[152.612212] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-pwrite
[152.614304] Subtest psr-1p-offscreen-pri-shrfb-draw-pwrite: SKIP (0.000s)
[153.092638] [037/130] (882s left) core_setmaster_vs_auth
[153.276929] [038/130] (882s left) api_intel_bb (intel-bb-blit-x)
[153.335478] Starting subtest: intel-bb-blit-x
[156.275222] Subtest intel-bb-blit-x: SUCCESS (2.940s)
[156.435091] [039/130] (879s left) kms_plane_scaling (plane-downscale-factor-0-5-with-modifiers)
[156.789553] Starting subtest: plane-downscale-factor-0-5-with-modifiers
[156.790635] Starting dynamic subtest: pipe-A
[156.793822] Dynamic subtest pipe-A: SKIP (0.001s)
[156.806026] Starting dynamic subtest: pipe-B
[156.809125] Dynamic subtest pipe-B: SKIP (0.001s)
[156.811108] Subtest plane-downscale-factor-0-5-with-modifiers: SKIP (0.004s)
[157.269749] [040/130] (878s left) kms_pm_rpm (pm-caching)
[158.816580] Subtest pm-caching: SKIP (0.000s)
[159.046985] [041/130] (877s left) gem_linear_blits (basic)
[159.267618] Starting subtest: basic
[159.280205] Subtest basic: SUCCESS (0.013s)
[159.470386] [042/130] (876s left) gem_wait (wait)
[159.653597] Starting subtest: wait
[159.654604] Starting dynamic subtest: all-engines
[160.675678] Dynamic subtest all-engines: SUCCESS (1.021s)
[160.689301] Starting dynamic subtest: rcs0
[161.706699] Dynamic subtest rcs0: SUCCESS (1.028s)
[161.719811] Starting dynamic subtest: bcs0
[162.739537] Dynamic subtest bcs0: SUCCESS (1.030s)
[162.751969] Starting dynamic subtest: vcs0
[163.758440] Dynamic subtest vcs0: SUCCESS (1.017s)
[163.759568] Subtest wait: SUCCESS (4.106s)
[164.009289] [043/130] (872s left) gem_ctx_shared (q-in-order)
[164.068385] Subtest Q-in-order: SKIP (0.000s)
[164.191338] [044/130] (872s left) kms_chamelium_hpd (dp-hpd-fast)
[164.639918] Subtest dp-hpd-fast: SKIP (0.000s)
[164.996012] [045/130] (871s left) kms_cursor_crc (cursor-offscreen-128x42)
[165.384486] Starting subtest: cursor-offscreen-128x42
[165.444945] Subtest cursor-offscreen-128x42: SKIP (0.058s)
[165.921965] [046/130] (870s left) kms_content_protection (dp-mst-lic-type-1)
[166.295961] Starting subtest: dp-mst-lic-type-1
[166.300182] Subtest dp-mst-lic-type-1: SKIP (0.000s)
[166.750626] [047/130] (869s left) gem_exec_flush (basic-batch-kernel-default-cmd)
[166.816644] Starting subtest: basic-batch-kernel-default-cmd
[166.819140] Subtest basic-batch-kernel-default-cmd: SKIP (0.000s)
[167.048742] [048/130] (869s left) kms_psr (fbc-psr2-cursor-blt)
[167.400388] Subtest fbc-psr2-cursor-blt: SKIP (0.000s)
[167.631374] [049/130] (868s left) kms_lease (lease-again)
[167.984301] Starting subtest: lease-again
[167.985280] Starting dynamic subtest: pipe-A-HDMI-A-1
[167.987765] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.002s)
[168.000120] Starting dynamic subtest: pipe-B-HDMI-A-1
[168.001216] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.001s)
[168.002305] Subtest lease-again: SUCCESS (0.009s)
[168.464388] [050/130] (868s left) kms_plane_multiple (2x-tiling-4)
[168.821587] Starting subtest: 2x-tiling-4
[168.823836] Subtest 2x-tiling-4: SKIP (0.000s)
[169.281849] [051/130] (867s left) kms_async_flips (async-flip-hang)
[169.638332] Starting subtest: async-flip-hang
[169.779766] Starting dynamic subtest: pipe-A-HDMI-A-1
[176.885715] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (7.104s)
[177.016712] Starting dynamic subtest: pipe-B-HDMI-A-1
[182.897265] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (5.890s)
[182.898284] Subtest async-flip-hang: SUCCESS (13.260s)
[183.616249] [052/130] (853s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-32bpp-xtile-downscaling)
[183.673112] Subtest flip-64bpp-xtile-to-32bpp-xtile-downscaling: SKIP (0.000s)
[183.732329] [053/130] (853s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180-async-flip)
[184.100522] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180-async-flip
[184.679506] Subtest x-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SUCCESS (0.578s)
[185.199705] [054/130] (851s left) gem_exec_reloc (basic-concurrent0)
[185.261531] Starting subtest: basic-concurrent0
[190.652599] Subtest basic-concurrent0: SUCCESS (5.392s)
[191.417507] [055/130] (845s left) syncobj_timeline (etime-single-wait-submitted)
[191.485703] Starting subtest: etime-single-wait-submitted
[191.594277] Subtest etime-single-wait-submitted: SUCCESS (0.108s)
[191.739315] [056/130] (845s left) kms_psr (fbc-pr-sprite-plane-onoff)
[192.092907] Subtest fbc-pr-sprite-plane-onoff: SKIP (0.000s)
[192.337356] [057/130] (844s left) gem_partial_pwrite_pread (reads)
[192.395335] Starting subtest: reads
[193.530854] Subtest reads: SUCCESS (1.135s)
[193.697958] [058/130] (843s left) syncobj_timeline (wait-all-interrupted)
[193.758806] Starting subtest: wait-all-interrupted
[193.866220] Subtest wait-all-interrupted: SUCCESS (0.108s)
[194.000353] [059/130] (843s left) syncobj_timeline (invalid-wait-bad-flags)
[194.060489] Starting subtest: invalid-wait-bad-flags
[194.061585] Subtest invalid-wait-bad-flags: SUCCESS (0.000s)
[194.198507] [060/130] (842s left) kms_psr2_sf (fbc-psr2-plane-move-sf-dmg-area)
[194.555192] Subtest fbc-psr2-plane-move-sf-dmg-area: SKIP (0.000s)
[194.789476] [061/130] (842s left) kms_dp_link_training (uhbr-sst)
[195.146287] Starting subtest: uhbr-sst
[195.148408] Subtest uhbr-sst: SKIP (0.000s)
[195.429048] [062/130] (841s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-pwrite)
[195.787806] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-pwrite
[195.790147] Subtest psr-2p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[196.242982] [063/130] (841s left) kms_frontbuffer_tracking (fbc-2p-rte)
[196.599067] Starting subtest: fbc-2p-rte
[196.601225] Subtest fbc-2p-rte: SKIP (0.000s)
[197.077989] [064/130] (840s left) gem_create (create-ext-placement-all)
[197.245898] Starting subtest: create-ext-placement-all
[197.247021] Subtest create-ext-placement-all: SUCCESS (0.000s)
[197.372490] [065/130] (840s left) gem_close (many-handles-one-vma)
[197.430415] Starting subtest: many-handles-one-vma
[197.467602] Subtest many-handles-one-vma: SUCCESS (0.037s)
[197.625382] [066/130] (839s left) gem_fenced_exec_thrash (no-spare-fences-busy)
[197.684896] Starting subtest: no-spare-fences-busy
[199.860759] Subtest no-spare-fences-busy: SUCCESS (2.175s)
[200.002699] [067/130] (837s left) gem_pxp (fail-invalid-protected-context)
[202.573068] Starting subtest: fail-invalid-protected-context
[202.576136] Subtest fail-invalid-protected-context: SKIP (0.000s)
[202.695883] [068/130] (834s left) i915_drm_fdinfo (virtual-busy-hang-all)
[202.754344] Subtest virtual-busy-hang-all: SKIP (0.000s)
[202.824565] [069/130] (834s left) syncobj_wait (single-wait-signaled)
[202.889457] Starting subtest: single-wait-signaled
[202.890625] Subtest single-wait-signaled: SUCCESS (0.000s)
[203.015419] [070/130] (834s left) kms_sequence (get-forked-busy)
[203.368032] Starting subtest: get-forked-busy
[203.369157] Starting dynamic subtest: pipe-A-HDMI-A-1
[205.785358] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (2.417s)
[205.800233] Starting dynamic subtest: pipe-B-HDMI-A-1
[208.229597] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (2.441s)
[208.230731] Subtest get-forked-busy: SUCCESS (4.863s)
[208.808477] [071/130] (828s left) prime_udl
[208.931625] [072/130] (828s left) kms_ccs (random-ccs-data-4-tiled-mtl-rc-ccs)
[208.989433] Subtest random-ccs-data-4-tiled-mtl-rc-ccs: SKIP (0.000s)
[209.050806] [073/130] (828s left) kms_flip (wf_vblank-ts-check-interruptible)
[209.410622] Starting subtest: wf_vblank-ts-check-interruptible
[209.413352] Starting dynamic subtest: A-VGA1
[217.436471] Dynamic subtest A-VGA1: SUCCESS (8.024s)
[217.449511] Starting dynamic subtest: B-VGA1
[225.426950] Dynamic subtest B-VGA1: SUCCESS (7.987s)
[225.442362] Starting dynamic subtest: A-HDMI-A1
[233.586211] Dynamic subtest A-HDMI-A1: SUCCESS (8.156s)
[233.599781] Starting dynamic subtest: B-HDMI-A1
[241.792996] Dynamic subtest B-HDMI-A1: SUCCESS (8.204s)
[241.797174] Subtest wf_vblank-ts-check-interruptible: SUCCESS (32.384s)
[242.433925] [074/130] (795s left) kms_frontbuffer_tracking (fbcpsr-rgb565-draw-mmap-gtt)
[242.786978] Starting subtest: fbcpsr-rgb565-draw-mmap-gtt
[242.789245] Subtest fbcpsr-rgb565-draw-mmap-gtt: SKIP (0.000s)
[243.261940] [075/130] (794s left) kms_flip (modeset-vs-vblank-race-interruptible)
[243.626457] Starting subtest: modeset-vs-vblank-race-interruptible
[243.627490] Starting dynamic subtest: A-VGA1
[246.690499] Dynamic subtest A-VGA1: SUCCESS (3.063s)
[246.704258] Starting dynamic subtest: B-VGA1
[249.805306] Dynamic subtest B-VGA1: SUCCESS (3.111s)
[249.818575] Starting dynamic subtest: A-HDMI-A1
[252.916570] Dynamic subtest A-HDMI-A1: SUCCESS (3.106s)
[252.927967] Starting dynamic subtest: B-HDMI-A1
[256.042712] Dynamic subtest B-HDMI-A1: SUCCESS (3.125s)
[256.046328] Subtest modeset-vs-vblank-race-interruptible: SUCCESS (12.419s)
[256.717271] [076/130] (781s left) gem_exec_whisper (basic-queues-all)
[256.800483] Starting subtest: basic-queues-all
[256.805599] Subtest basic-queues-all: SKIP (0.003s)
[257.050544] [077/130] (781s left) kms_atomic (atomic-invalid-params)
[257.402359] Starting subtest: atomic-invalid-params
[257.403397] Starting dynamic subtest: pipe-A-HDMI-A-1
[257.611034] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.208s)
[257.612080] Subtest atomic-invalid-params: SUCCESS (0.211s)
[258.189333] [078/130] (779s left) gem_exec_whisper (basic-fds-forked-all)
[258.256515] Starting subtest: basic-fds-forked-all
[261.810339] Subtest basic-fds-forked-all: SUCCESS (3.553s)
[262.049853] [079/130] (776s left) syncobj_wait (wait-all-interrupted)
[262.109040] Starting subtest: wait-all-interrupted
[262.211129] Subtest wait-all-interrupted: SUCCESS (0.101s)
[262.350304] [080/130] (775s left) kms_flip_scaled_crc (flip-32bpp-yftileccs-to-64bpp-yftile-upscaling)
[262.405393] Subtest flip-32bpp-yftileccs-to-64bpp-yftile-upscaling: SKIP (0.000s)
[262.480239] [081/130] (775s left) kms_pm_backlight (brightness-with-dpms)
[262.837810] Subtest brightness-with-dpms: SKIP (0.000s)
[263.073820] [082/130] (775s left) syncobj_wait (wait-any-complex)
[263.130534] Starting subtest: wait-any-complex
[263.192895] Subtest wait-any-complex: SUCCESS (0.063s)
[263.329157] [083/130] (775s left) kms_big_fb (4-tiled-32bpp-rotate-90)
[263.694163] Starting subtest: 4-tiled-32bpp-rotate-90
[263.697077] Subtest 4-tiled-32bpp-rotate-90: SKIP (0.000s)
[264.163151] [084/130] (774s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-mmap-cpu)
[264.530216] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-mmap-cpu
[264.532309] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[264.977225] [085/130] (773s left) kms_debugfs (display-off-read-all)
[265.333349] Starting subtest: display-off-read-all
[265.408760] Subtest display-off-read-all: SUCCESS (0.078s)
[265.989931] [086/130] (772s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc)
[266.360645] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc
[266.362899] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-mmap-wc: SKIP (0.000s)
[266.839121] [087/130] (771s left) kms_addfb_basic (framebuffer-vs-set-tiling)
[266.896598] Starting subtest: framebuffer-vs-set-tiling
[266.897640] Subtest framebuffer-vs-set-tiling: SUCCESS (0.000s)
[267.672351] [088/130] (770s left) prime_mmap (test_correct)
[267.732215] Starting subtest: test_correct
[267.733277] Starting dynamic subtest: test_correct-smem
[267.735761] Dynamic subtest test_correct-smem: SUCCESS (0.003s)
[267.739272] Subtest test_correct: SUCCESS (0.005s)
[267.887945] [089/130] (770s left) kms_cursor_crc (cursor-rapid-movement-64x21)
[268.242949] Starting subtest: cursor-rapid-movement-64x21
[268.296954] Subtest cursor-rapid-movement-64x21: SKIP (0.053s)
[268.768573] [090/130] (770s left) kms_invalid_mode (bad-hsync-start)
[269.123775] Starting subtest: bad-hsync-start
[269.124878] Starting dynamic subtest: pipe-A-HDMI-A-1
[269.198451] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.074s)
[269.213568] Starting dynamic subtest: pipe-B-HDMI-A-1
[269.214653] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.001s)
[269.215733] Subtest bad-hsync-start: SUCCESS (0.081s)
[269.648929] [091/130] (769s left) kms_cursor_legacy (basic-busy-flip-before-cursor-legacy)
[269.999385] Starting subtest: basic-busy-flip-before-cursor-legacy
[270.979049] Subtest basic-busy-flip-before-cursor-legacy: SUCCESS (0.980s)
[271.560697] [092/130] (767s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip)
[271.925258] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip
[271.927409] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip: SKIP (0.000s)
[272.374633] [093/130] (766s left) gem_tiled_partial_pwrite_pread (reads)
[272.436356] Starting subtest: reads
[272.724799] Subtest reads: SUCCESS (0.289s)
[272.891714] [094/130] (766s left) kms_big_fb (y-tiled-max-hw-stride-64bpp-rotate-180-async-flip)
[273.266126] Starting subtest: y-tiled-max-hw-stride-64bpp-rotate-180-async-flip
[273.268209] Subtest y-tiled-max-hw-stride-64bpp-rotate-180-async-flip: SKIP (0.000s)
[273.752430] [095/130] (765s left) gem_exec_schedule (manyslice)
[273.819493] Subtest manyslice: SKIP (0.000s)
[274.053437] [096/130] (765s left) kms_chamelium_audio (hdmi-audio-edid)
[274.486416] Subtest hdmi-audio-edid: SKIP (0.000s)
[274.829923] [097/130] (764s left) kms_big_fb (x-tiled-16bpp-rotate-90)
[275.190120] Starting subtest: x-tiled-16bpp-rotate-90
[275.198380] Subtest x-tiled-16bpp-rotate-90: SKIP (0.008s)
[275.686881] [098/130] (763s left) gem_userptr_blits (unsync-overlap)
[275.747578] Subtest unsync-overlap: SKIP (0.000s)
[275.900707] [099/130] (763s left) i915_query (query-garbage)
[275.961713] Starting subtest: query-garbage
[275.962839] Subtest query-garbage: SUCCESS (0.000s)
[276.094976] [100/130] (763s left) perf_pmu (frequency)
[276.152342] Starting subtest: frequency
[276.156160] Starting dynamic subtest: gt0
[278.249702] Dynamic subtest gt0: SUCCESS (2.091s)
[278.266334] Starting dynamic subtest: idle-gt0
[278.756063] Dynamic subtest idle-gt0: SUCCESS (0.504s)
[278.757118] Subtest frequency: SUCCESS (2.605s)
[278.877402] [101/130] (760s left) gem_exec_schedule (semaphore-user)
[278.946522] Subtest semaphore-user: SKIP (0.000s)
[279.190461] [102/130] (760s left) gem_exec_reloc (basic-gtt-read-noreloc)
[279.248446] Starting subtest: basic-gtt-read-noreloc
[279.251071] Subtest basic-gtt-read-noreloc: SUCCESS (0.002s)
[279.987716] [103/130] (759s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-0-hflip)
[280.349911] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-0-hflip
[280.352090] Subtest y-tiled-max-hw-stride-32bpp-rotate-0-hflip: SKIP (0.000s)
[280.804780] [104/130] (758s left) perf_pmu (busy-accuracy-50)
[280.862993] Starting subtest: busy-accuracy-50
[280.864055] Starting dynamic subtest: rcs0
[280.866255] Dynamic subtest rcs0: SKIP (0.000s)
[280.883670] Starting dynamic subtest: bcs0
[280.885997] Dynamic subtest bcs0: SKIP (0.000s)
[280.901017] Starting dynamic subtest: vcs0
[280.903531] Dynamic subtest vcs0: SKIP (0.000s)
[280.905877] Subtest busy-accuracy-50: SKIP (0.004s)
[281.002272] [105/130] (758s left) kms_chamelium_edid (dp-mode-timings)
[281.451179] Subtest dp-mode-timings: SKIP (0.000s)
[281.799704] [106/130] (757s left) kms_frontbuffer_tracking (fbc-2p-primscrn-shrfb-pgflip-blt)
[282.159724] Starting subtest: fbc-2p-primscrn-shrfb-pgflip-blt
[282.161945] Subtest fbc-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[282.634915] [107/130] (757s left) gem_ringfill (legacy-basic)
[282.816882] Starting subtest: legacy-basic
[282.819794] Starting dynamic subtest: default
[282.841672] Dynamic subtest default: SUCCESS (0.023s)
[282.858603] Starting dynamic subtest: render
[282.863447] Dynamic subtest render: SUCCESS (0.018s)
[282.882055] Starting dynamic subtest: bsd
[282.884423] Dynamic subtest bsd: SKIP (0.000s)
[282.901827] Starting dynamic subtest: bsd1
[282.904245] Dynamic subtest bsd1: SKIP (0.000s)
[282.924204] Starting dynamic subtest: blt
[282.925656] Dynamic subtest blt: SUCCESS (0.019s)
[282.926841] Subtest legacy-basic: SUCCESS (0.076s)
[283.033211] [108/130] (756s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-render)
[283.395188] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-render
[283.397386] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-render: SKIP (0.000s)
[283.868324] [109/130] (756s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[284.229795] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[284.232155] Subtest psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[284.709553] [110/130] (755s left) kms_ccs (ccs-on-another-bo-4-tiled-mtl-mc-ccs)
[284.766506] Subtest ccs-on-another-bo-4-tiled-mtl-mc-ccs: SKIP (0.000s)
[284.827763] [111/130] (755s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-onoff)
[285.184739] Starting subtest: fbc-2p-scndscrn-cur-indfb-onoff
[285.186914] Subtest fbc-2p-scndscrn-cur-indfb-onoff: SKIP (0.000s)
[285.660900] [112/130] (754s left) i915_suspend (sysfs-reader)
[285.720526] Starting subtest: sysfs-reader
[310.431176] Subtest sysfs-reader: SUCCESS (8.180s)
[317.508281] [113/130] (729s left) prime_self_import (basic-with_fd_dup)
[317.569050] Starting subtest: basic-with_fd_dup
[317.573438] Subtest basic-with_fd_dup: SUCCESS (0.004s)
[317.731496] [114/130] (729s left) gem_ctx_persistence (engines-mixed-process)
[317.792908] Subtest engines-mixed-process: SKIP (0.000s)
[317.862503] [115/130] (729s left) gem_exec_params (sol-reset-not-gen7)
[317.920201] Starting subtest: sol-reset-not-gen7
[317.921243] Subtest sol-reset-not-gen7: SUCCESS (0.001s)
[318.084080] [116/130] (729s left) kms_psr (psr2-primary-mmap-cpu)
[318.439057] Subtest psr2-primary-mmap-cpu: SKIP (0.000s)
[318.678763] [117/130] (728s left) gem_spin_batch (legacy-resubmit-new)
[318.746311] Starting subtest: legacy-resubmit-new
[318.747454] Starting dynamic subtest: default
[318.749960] Dynamic subtest default: SUCCESS (0.002s)
[318.765242] Starting dynamic subtest: render
[318.766202] Dynamic subtest render: SUCCESS (0.001s)
[318.780618] Starting dynamic subtest: bsd
[318.781695] Dynamic subtest bsd: SUCCESS (0.001s)
[318.795932] Starting dynamic subtest: bsd1
[318.796869] Dynamic subtest bsd1: SUCCESS (0.001s)
[318.811088] Starting dynamic subtest: blt
[318.812110] Dynamic subtest blt: SUCCESS (0.001s)
[318.813118] Subtest legacy-resubmit-new: SUCCESS (0.013s)
[319.002273] [118/130] (728s left) syncobj_timeline (device-submit-unordered)
[319.064444] Starting subtest: device-submit-unordered
[319.065564] Subtest device-submit-unordered: SUCCESS (0.001s)
[319.206245] [119/130] (728s left) kms_big_fb (linear-64bpp-rotate-90)
[319.575229] Starting subtest: linear-64bpp-rotate-90
[319.581875] Subtest linear-64bpp-rotate-90: SKIP (0.007s)
[320.041016] [120/130] (727s left) gem_ctx_persistence (userptr)
[320.100982] Subtest userptr: SKIP (0.000s)
[320.167512] [121/130] (727s left) gem_eio (execbuf)
[320.232306] Starting subtest: execbuf
[320.262053] Subtest execbuf: SUCCESS (0.028s)
[321.056790] [122/130] (726s left) gem_busy (close-race)
[321.130315] Starting subtest: close-race
[343.076562] Subtest close-race: SUCCESS (21.906s)
[343.479324] [123/130] (704s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-render)
[343.914979] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-render
[343.917824] Subtest psr-2p-scndscrn-spr-indfb-draw-render: SKIP (0.000s)
[344.405440] [124/130] (703s left) kms_flip (single-buffer-flip-vs-dpms-off-vs-modeset)
[344.767562] Starting subtest: single-buffer-flip-vs-dpms-off-vs-modeset
[344.770098] Starting dynamic subtest: A-VGA1
[345.603090] Dynamic subtest A-VGA1: SUCCESS (0.832s)
[345.619261] Starting dynamic subtest: B-VGA1
[346.299129] Dynamic subtest B-VGA1: SUCCESS (0.694s)
[346.315686] Starting dynamic subtest: A-HDMI-A1
[347.094911] Dynamic subtest A-HDMI-A1: SUCCESS (0.791s)
[347.110064] Starting dynamic subtest: B-HDMI-A1
[347.886192] Dynamic subtest B-HDMI-A1: SUCCESS (0.792s)
[347.887264] Subtest single-buffer-flip-vs-dpms-off-vs-modeset: SUCCESS (3.117s)
[348.483688] [125/130] (699s left) gem_mmap_gtt (ptrace)
[348.546988] Starting subtest: ptrace
[348.630337] Subtest ptrace: SUCCESS (0.084s)
[348.785496] [126/130] (699s left) kms_psr (fbc-psr-primary-mmap-gtt)
[349.140679] Subtest fbc-psr-primary-mmap-gtt: SKIP (0.000s)
[349.375256] [127/130] (698s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-mmap-cpu)
[349.735761] Starting subtest: psr-1p-primscrn-spr-indfb-draw-mmap-cpu
[349.737984] Subtest psr-1p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[350.216125] [128/130] (697s left) kms_addfb_basic (unused-offsets)
[350.275993] Starting subtest: unused-offsets
[350.277030] Subtest unused-offsets: SUCCESS (0.000s)
[351.053436] [129/130] (697s left) tools_test (sysfs_l3_parity)
[351.116638] Starting subtest: sysfs_l3_parity
[351.176558] Subtest sysfs_l3_parity: SKIP (0.066s)
[351.331404] [130/130] (696s left) kms_rotation_crc (bad-tiling)
[351.687871] Starting subtest: bad-tiling
[351.689917] Subtest bad-tiling: SKIP (0.002s)
[352.160609] Closing watchdogs
results: parsing output: 0/ for test: kms_psr
results: parsing output: 1/ for test: i915_pm_rpm
results: parsing output: 2/ for test: kms_rotation_crc
results: parsing output: 3/ for test: gen9_exec_parse
results: parsing output: 4/ for test: kms_pm_rpm
results: parsing output: 5/ for test: kms_plane_alpha_blend
results: parsing output: 6/ for test: gem_exec_gttfill
results: parsing output: 7/ for test: kms_frontbuffer_tracking
results: parsing output: 8/ for test: kms_flip
results: parsing output: 9/ for test: gem_exec_fence
results: parsing output: 10/ for test: gen9_exec_parse
results: parsing output: 11/ for test: gem_exec_reloc
results: parsing output: 12/ for test: kms_rmfb
results: parsing output: 13/ for test: gem_mmap_wc
results: parsing output: 14/ for test: kms_ccs
results: parsing output: 15/ for test: kms_flip
results: parsing output: 16/ for test: gem_exec_balancer
results: parsing output: 17/ for test: kms_frontbuffer_tracking
results: parsing output: 18/ for test: gem_exec_balancer
results: parsing output: 19/ for test: kms_frontbuffer_tracking
results: parsing output: 20/ for test: kms_frontbuffer_tracking
results: parsing output: 21/ for test: kms_psr2_sf
results: parsing output: 22/ for test: kms_atomic_transition
results: parsing output: 23/ for test: kms_cursor_edge_walk
results: parsing output: 24/ for test: kms_ccs
results: parsing output: 25/ for test: gem_exec_reloc
results: parsing output: 26/ for test: syncobj_timeline
results: parsing output: 27/ for test: gem_lmem_swapping
results: parsing output: 28/ for test: kms_vrr
results: parsing output: 29/ for test: perf
results: parsing output: 30/ for test: fbdev
results: parsing output: 31/ for test: api_intel_allocator
results: parsing output: 32/ for test: kms_flip_scaled_crc
results: parsing output: 33/ for test: dmabuf_sync_file
results: parsing output: 34/ for test: perf_pmu
results: parsing output: 35/ for test: kms_frontbuffer_tracking
results: parsing output: 36/ for test: core_setmaster_vs_auth
results: parsing output: 37/ for test: api_intel_bb
results: parsing output: 38/ for test: kms_plane_scaling
results: parsing output: 39/ for test: kms_pm_rpm
results: parsing output: 40/ for test: gem_linear_blits
results: parsing output: 41/ for test: gem_wait
results: parsing output: 42/ for test: gem_ctx_shared
results: parsing output: 43/ for test: kms_chamelium_hpd
results: parsing output: 44/ for test: kms_cursor_crc
results: parsing output: 45/ for test: kms_content_protection
results: parsing output: 46/ for test: gem_exec_flush
results: parsing output: 47/ for test: kms_psr
results: parsing output: 48/ for test: kms_lease
results: parsing output: 49/ for test: kms_plane_multiple
results: parsing output: 50/ for test: kms_async_flips
results: parsing output: 51/ for test: kms_flip_scaled_crc
results: parsing output: 52/ for test: kms_big_fb
results: parsing output: 53/ for test: gem_exec_reloc
results: parsing output: 54/ for test: syncobj_timeline
results: parsing output: 55/ for test: kms_psr
results: parsing output: 56/ for test: gem_partial_pwrite_pread
results: parsing output: 57/ for test: syncobj_timeline
results: parsing output: 58/ for test: syncobj_timeline
results: parsing output: 59/ for test: kms_psr2_sf
results: parsing output: 60/ for test: kms_dp_link_training
results: parsing output: 61/ for test: kms_frontbuffer_tracking
results: parsing output: 62/ for test: kms_frontbuffer_tracking
results: parsing output: 63/ for test: gem_create
results: parsing output: 64/ for test: gem_close
results: parsing output: 65/ for test: gem_fenced_exec_thrash
results: parsing output: 66/ for test: gem_pxp
results: parsing output: 67/ for test: i915_drm_fdinfo
results: parsing output: 68/ for test: syncobj_wait
results: parsing output: 69/ for test: kms_sequence
results: parsing output: 70/ for test: prime_udl
results: parsing output: 71/ for test: kms_ccs
results: parsing output: 72/ for test: kms_flip
results: parsing output: 73/ for test: kms_frontbuffer_tracking
results: parsing output: 74/ for test: kms_flip
results: parsing output: 75/ for test: gem_exec_whisper
results: parsing output: 76/ for test: kms_atomic
results: parsing output: 77/ for test: gem_exec_whisper
results: parsing output: 78/ for test: syncobj_wait
results: parsing output: 79/ for test: kms_flip_scaled_crc
results: parsing output: 80/ for test: kms_pm_backlight
results: parsing output: 81/ for test: syncobj_wait
results: parsing output: 82/ for test: kms_big_fb
results: parsing output: 83/ for test: kms_frontbuffer_tracking
results: parsing output: 84/ for test: kms_debugfs
results: parsing output: 85/ for test: kms_frontbuffer_tracking
results: parsing output: 86/ for test: kms_addfb_basic
results: parsing output: 87/ for test: prime_mmap
results: parsing output: 88/ for test: kms_cursor_crc
results: parsing output: 89/ for test: kms_invalid_mode
results: parsing output: 90/ for test: kms_cursor_legacy
results: parsing output: 91/ for test: kms_big_fb
results: parsing output: 92/ for test: gem_tiled_partial_pwrite_pread
results: parsing output: 93/ for test: kms_big_fb
results: parsing output: 94/ for test: gem_exec_schedule
results: parsing output: 95/ for test: kms_chamelium_audio
results: parsing output: 96/ for test: kms_big_fb
results: parsing output: 97/ for test: gem_userptr_blits
results: parsing output: 98/ for test: i915_query
results: parsing output: 99/ for test: perf_pmu
results: parsing output: 100/ for test: gem_exec_schedule
results: parsing output: 101/ for test: gem_exec_reloc
results: parsing output: 102/ for test: kms_big_fb
results: parsing output: 103/ for test: perf_pmu
results: parsing output: 104/ for test: kms_chamelium_edid
results: parsing output: 105/ for test: kms_frontbuffer_tracking
results: parsing output: 106/ for test: gem_ringfill
results: parsing output: 107/ for test: kms_frontbuffer_tracking
results: parsing output: 108/ for test: kms_frontbuffer_tracking
results: parsing output: 109/ for test: kms_ccs
results: parsing output: 110/ for test: kms_frontbuffer_tracking
results: parsing output: 111/ for test: i915_suspend
results: parsing output: 112/ for test: prime_self_import
results: parsing output: 113/ for test: gem_ctx_persistence
results: parsing output: 114/ for test: gem_exec_params
results: parsing output: 115/ for test: kms_psr
results: parsing output: 116/ for test: gem_spin_batch
results: parsing output: 117/ for test: syncobj_timeline
results: parsing output: 118/ for test: kms_big_fb
results: parsing output: 119/ for test: gem_ctx_persistence
results: parsing output: 120/ for test: gem_eio
results: parsing output: 121/ for test: gem_busy
results: parsing output: 122/ for test: kms_frontbuffer_tracking
results: parsing output: 123/ for test: kms_flip
results: parsing output: 124/ for test: gem_mmap_gtt
results: parsing output: 125/ for test: kms_psr
results: parsing output: 126/ for test: kms_frontbuffer_tracking
results: parsing output: 127/ for test: kms_addfb_basic
results: parsing output: 128/ for test: tools_test
results: parsing output: 129/ for test: kms_rotation_crc
Done.