[67.599268] Initializing watchdogs
[67.599407]   /dev/watchdog0
[67.621179] [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)
[67.629073] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[67.632927] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[67.637197] [001/131] (960s left) kms_cursor_legacy (long-nonblocking-modeset-vs-cursor-atomic)
[68.013518] Starting subtest: long-nonblocking-modeset-vs-cursor-atomic
[71.349527] Subtest long-nonblocking-modeset-vs-cursor-atomic: SUCCESS (3.338s)
[71.912971] [002/131] (956s left) kms_chamelium_audio (hdmi-audio)
[72.353232] Subtest hdmi-audio: SKIP (0.000s)
[72.684347] [003/131] (955s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-indfb-pgflip-blt)
[73.049510] Starting subtest: fbcpsr-2p-primscrn-indfb-pgflip-blt
[73.052872] Subtest fbcpsr-2p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[73.496995] [004/131] (954s left) kms_busy (extended-modeset-hang-oldfb)
[73.868022] Starting subtest: extended-modeset-hang-oldfb
[73.869738] Starting dynamic subtest: pipe-A
[80.136481] Dynamic subtest pipe-A: SUCCESS (6.268s)
[80.146908] Starting dynamic subtest: pipe-B
[86.132706] Dynamic subtest pipe-B: SUCCESS (5.996s)
[86.134319] Subtest extended-modeset-hang-oldfb: SUCCESS (12.267s)
[86.680840] [005/131] (941s left) kms_vblank (ts-continuation-idle-hang)
[87.045774] Starting subtest: ts-continuation-idle-hang
[87.047809] Starting dynamic subtest: pipe-A-HDMI-A-1
[92.922726] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (5.875s)
[92.935317] Starting dynamic subtest: pipe-B-HDMI-A-1
[98.942737] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (6.018s)
[98.944314] Subtest ts-continuation-idle-hang: SUCCESS (11.898s)
[99.487360] [006/131] (928s left) gem_readwrite (new-obj)
[99.549717] Starting subtest: new-obj
[99.553097] Subtest new-obj: SUCCESS (0.000s)
[99.652306] [007/131] (928s left) kms_cursor_crc (cursor-onscreen-512x512)
[100.025701] Starting subtest: cursor-onscreen-512x512
[100.028917] Subtest cursor-onscreen-512x512: SKIP (0.001s)
[100.467248] [008/131] (928s left) i915_pm_rps (reset)
[100.533416] Starting subtest: reset
[104.063986] Subtest reset: SUCCESS (3.531s)
[104.174498] [009/131] (924s left) kms_color (ctm-blue-to-red)
[104.536176] Starting subtest: ctm-blue-to-red
[104.537980] Starting dynamic subtest: pipe-A-HDMI-A-1
[105.011053] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.475s)
[105.021182] Starting dynamic subtest: pipe-B-HDMI-A-1
[105.536743] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.525s)
[105.538423] Subtest ctm-blue-to-red: SUCCESS (1.001s)
[106.079642] [010/131] (922s left) kms_async_flips (test-time-stamp)
[106.443035] Starting subtest: test-time-stamp
[106.585779] Starting dynamic subtest: pipe-A-HDMI-A-1
[106.779161] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.192s)
[106.939886] Starting dynamic subtest: pipe-B-HDMI-A-1
[107.062156] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.131s)
[107.064456] Subtest test-time-stamp: SUCCESS (0.617s)
[107.774547] [011/131] (920s left) gen9_exec_parse (shadow-peek)
[107.839627] Subtest shadow-peek: SKIP (0.000s)
[107.903101] [012/131] (920s left) kms_psr2_sf (fbc-pr-cursor-plane-move-continuous-sf)
[108.261132] Subtest fbc-pr-cursor-plane-move-continuous-sf: SKIP (0.000s)
[108.481992] [013/131] (920s left) perf (non-sampling-read-error)
[108.593853] Subtest non-sampling-read-error: SKIP (0.000s)
[108.649077] [014/131] (920s left) kms_pm_backlight (bad-brightness)
[109.006947] Subtest bad-brightness: SKIP (0.000s)
[109.233782] [015/131] (919s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-msflip-blt)
[109.598383] Starting subtest: psr-1p-primscrn-shrfb-msflip-blt
[109.601718] Subtest psr-1p-primscrn-shrfb-msflip-blt: SKIP (0.000s)
[110.034996] [016/131] (918s left) gem_exec_schedule (manyslice)
[110.104994] Subtest manyslice: SKIP (0.000s)
[110.303183] [017/131] (918s left) kms_pm_rpm (basic-pci-d3-state)
[121.895392] Subtest basic-pci-d3-state: SKIP (0.000s)
[122.124296] [018/131] (906s left) core_setmaster (master-drop-set-root)
[122.224186] Starting subtest: master-drop-set-root
[122.230841] Subtest master-drop-set-root: SUCCESS (0.005s)
[122.295475] [019/131] (906s left) gem_busy (extended)
[122.489498] Starting subtest: extended
[122.491384] Starting dynamic subtest: rcs0
[122.517218] Dynamic subtest rcs0: SUCCESS (0.029s)
[122.535232] Starting dynamic subtest: bcs0
[122.537029] Dynamic subtest bcs0: SUCCESS (0.018s)
[122.538633] Subtest extended: SUCCESS (0.049s)
[122.777575] [020/131] (906s left) gem_exec_schedule (smoketest)
[122.846482] Subtest smoketest: SKIP (0.000s)
[123.043157] [021/131] (906s left) syncobj_wait (single-wait-all-for-submit-signaled)
[123.102126] Starting subtest: single-wait-all-for-submit-signaled
[123.103744] Subtest single-wait-all-for-submit-signaled: SUCCESS (0.000s)
[123.190290] [022/131] (905s left) kms_plane_scaling (plane-scaler-unity-scaling-with-pixel-format)
[123.550303] Starting subtest: plane-scaler-unity-scaling-with-pixel-format
[123.552062] Starting dynamic subtest: pipe-A
[123.556888] Dynamic subtest pipe-A: SKIP (0.001s)
[123.570126] Starting dynamic subtest: pipe-B
[123.575776] Dynamic subtest pipe-B: SKIP (0.001s)
[123.579761] Subtest plane-scaler-unity-scaling-with-pixel-format: SKIP (0.003s)
[123.996226] [023/131] (905s left) kms_cursor_crc (cursor-sliding-256x85)
[124.369416] Starting subtest: cursor-sliding-256x85
[124.429852] Subtest cursor-sliding-256x85: SKIP (0.056s)
[124.853929] [024/131] (904s left) kms_cursor_legacy (cursora-vs-flipb-toggle)
[125.207786] Starting subtest: cursorA-vs-flipB-toggle
[125.212432] Subtest cursorA-vs-flipB-toggle: SKIP (0.001s)
[125.654082] [025/131] (903s left) kms_psr (fbc-psr2-sprite-render)
[126.013037] Subtest fbc-psr2-sprite-render: SKIP (0.000s)
[126.245123] [026/131] (903s left) kms_addfb_basic (bad-pitch-256)
[126.303784] Starting subtest: bad-pitch-256
[126.305420] Subtest bad-pitch-256: SUCCESS (0.000s)
[127.032220] [027/131] (902s left) kms_psr (pr-dpms)
[127.395311] Subtest pr-dpms: SKIP (0.000s)
[127.628249] [028/131] (901s left) gem_lmem_swapping (heavy-random)
[127.689973] Subtest heavy-random: SKIP (0.000s)
[127.745848] [029/131] (901s left) gem_softpin (allocator-nopin-reserve)
[127.808047] Subtest allocator-nopin-reserve: SKIP (0.000s)
[127.901595] [030/131] (901s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-spr-indfb-onoff)
[128.268495] Starting subtest: fbcpsr-2p-primscrn-spr-indfb-onoff
[128.271597] Subtest fbcpsr-2p-primscrn-spr-indfb-onoff: SKIP (0.000s)
[128.715119] [031/131] (900s left) syncobj_timeline (multi-wait-signaled)
[128.772531] Starting subtest: multi-wait-signaled
[128.774036] Subtest multi-wait-signaled: SUCCESS (0.001s)
[128.859142] [032/131] (900s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-mmap-cpu)
[129.225971] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-mmap-cpu
[129.229305] Subtest psr-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[129.664662] [033/131] (900s left) gem_exec_gttfill (all-engines)
[129.736071] Starting subtest: all-engines
[153.757689] Subtest all-engines: SUCCESS (24.021s)
[153.959479] [034/131] (875s left) gem_exec_params (no-bsd)
[154.068554] Starting subtest: no-bsd
[154.070121] Subtest no-bsd: SUCCESS (0.000s)
[154.184188] [035/131] (875s left) gem_exec_params (cliprects_ptr-dirt)
[154.240880] Starting subtest: cliprects_ptr-dirt
[154.242575] Subtest cliprects_ptr-dirt: SUCCESS (0.000s)
[154.336669] [036/131] (875s left) api_intel_allocator (alloc-simple)
[154.389430] Starting subtest: alloc-simple
[154.393796] Subtest alloc-simple: SUCCESS (0.005s)
[154.515047] [037/131] (875s left) gem_exec_whisper (basic-fds-priority)
[154.583785] Starting subtest: basic-fds-priority
[154.587583] Subtest basic-fds-priority: SKIP (0.001s)
[154.778232] [038/131] (875s left) syncobj_timeline (single-wait-all-signaled)
[154.849265] Starting subtest: single-wait-all-signaled
[154.851084] Subtest single-wait-all-signaled: SUCCESS (0.000s)
[154.945300] [039/131] (875s left) kms_ccs (crc-primary-rotation-180-4-tiled-mtl-rc-ccs)
[155.002990] Subtest crc-primary-rotation-180-4-tiled-mtl-rc-ccs: SKIP (0.000s)
[155.060266] [040/131] (875s left) kms_frontbuffer_tracking (psr-1p-primscrn-cur-indfb-draw-mmap-wc)
[155.437075] Starting subtest: psr-1p-primscrn-cur-indfb-draw-mmap-wc
[155.441303] Subtest psr-1p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[155.877621] [041/131] (874s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-onoff)
[156.241050] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-onoff
[156.244469] Subtest fbcpsr-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s)
[156.674555] [042/131] (873s left) kms_pm_rpm (pm-tiling)
[168.325178] Subtest pm-tiling: SKIP (0.000s)
[168.545524] [043/131] (861s left) kms_vrr (flip-basic)
[168.909914] Starting subtest: flip-basic
[168.914776] Subtest flip-basic: SKIP (0.000s)
[169.347418] [044/131] (860s left) gem_ppgtt (blt-vs-render-ctxn)
[169.410943] Starting subtest: blt-vs-render-ctxN
[201.977546] Subtest blt-vs-render-ctxN: SUCCESS (32.565s)
[202.127717] [045/131] (828s left) gem_exec_flush (basic-uc-set-default)
[202.266923] Starting subtest: basic-uc-set-default
[207.710817] Subtest basic-uc-set-default: SUCCESS (5.444s)
[207.903667] [046/131] (822s left) kms_frontbuffer_tracking (fbcpsr-farfromfence-mmap-gtt)
[208.283293] Starting subtest: fbcpsr-farfromfence-mmap-gtt
[208.286385] Subtest fbcpsr-farfromfence-mmap-gtt: SKIP (0.000s)
[208.716557] [047/131] (821s left) kms_chamelium_hpd (common-hpd-after-suspend)
[209.156362] Subtest common-hpd-after-suspend: SKIP (0.000s)
[209.494246] [048/131] (821s left) kms_addfb_basic (unused-handle)
[209.553394] Starting subtest: unused-handle
[209.555064] Subtest unused-handle: SUCCESS (0.000s)
[210.294325] [049/131] (820s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip)
[210.663771] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip
[210.667091] Subtest 4-tiled-max-hw-stride-64bpp-rotate-0-hflip-async-flip: SKIP (0.000s)
[211.104495] [050/131] (819s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-pwrite)
[211.475231] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-pwrite
[211.478529] Subtest fbc-2p-scndscrn-spr-indfb-draw-pwrite: SKIP (0.000s)
[211.906780] [051/131] (818s left) gem_exec_store (pages)
[211.996823] Starting subtest: pages
[211.998671] Starting dynamic subtest: rcs0
[212.064764] Dynamic subtest rcs0: SUCCESS (0.067s)
[212.080712] Starting dynamic subtest: bcs0
[212.108517] Dynamic subtest bcs0: SUCCESS (0.042s)
[212.110588] Subtest pages: SUCCESS (0.112s)
[212.307586] [052/131] (818s left) gem_exec_reloc (basic-gtt-active)
[212.368893] Starting subtest: basic-gtt-active
[212.480202] Subtest basic-gtt-active: SUCCESS (0.110s)
[213.221311] [053/131] (817s left) syncobj_wait (wait-all-snapshot)
[213.290462] Starting subtest: wait-all-snapshot
[213.374057] Subtest wait-all-snapshot: SUCCESS (0.082s)
[213.474329] [054/131] (817s left) gem_eio (wait-1us)
[213.539292] Starting subtest: wait-1us
[213.570514] Subtest wait-1us: SUCCESS (0.031s)
[214.309099] [055/131] (816s left) perf_pmu (semaphore-wait-idle)
[214.369152] Starting subtest: semaphore-wait-idle
[214.370787] Starting dynamic subtest: rcs0
[214.373909] Dynamic subtest rcs0: SKIP (0.001s)
[214.389864] Starting dynamic subtest: bcs0
[214.394174] Dynamic subtest bcs0: SKIP (0.000s)
[214.413058] Starting dynamic subtest: vcs0
[214.417172] Dynamic subtest vcs0: SKIP (0.000s)
[214.421143] Subtest semaphore-wait-idle: SKIP (0.004s)
[214.487081] [056/131] (816s left) kms_flip_scaled_crc (flip-32bpp-linear-to-64bpp-linear-upscaling)
[214.549954] Subtest flip-32bpp-linear-to-64bpp-linear-upscaling: SKIP (0.000s)
[214.598414] [057/131] (816s left) kms_psr (psr2-sprite-mmap-cpu)
[214.968055] Subtest psr2-sprite-mmap-cpu: SKIP (0.000s)
[215.199474] [058/131] (815s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-render)
[215.573536] Starting subtest: psr-1p-primscrn-spr-indfb-draw-render
[215.576835] Subtest psr-1p-primscrn-spr-indfb-draw-render: SKIP (0.000s)
[216.016667] [059/131] (815s left) kms_legacy_colorkey (basic)
[216.381287] Starting subtest: basic
[216.383053] Starting dynamic subtest: pipe-A
[216.384724] Dynamic subtest pipe-A: SUCCESS (0.000s)
[216.399359] Starting dynamic subtest: pipe-B
[216.401372] Dynamic subtest pipe-B: SUCCESS (0.000s)
[216.403502] Subtest basic: SUCCESS (0.003s)
[216.816265] [060/131] (814s left) prime_mmap_coherency (ioctl-errors)
[216.882681] Starting subtest: ioctl-errors
[225.875868] Subtest ioctl-errors: SUCCESS (8.995s)
[226.014980] [061/131] (805s left) kms_addfb_basic (legacy-format)
[226.146805] Starting subtest: legacy-format
[226.226775] Subtest legacy-format: SUCCESS (0.077s)
[226.955876] [062/131] (804s left) sysfs_heartbeat_interval (invalid)
[227.022638] Starting subtest: invalid
[227.024209] Starting dynamic subtest: vcs0
[227.025814] Dynamic subtest vcs0: SUCCESS (0.001s)
[227.037449] Starting dynamic subtest: bcs0
[227.038997] Dynamic subtest bcs0: SUCCESS (0.000s)
[227.050042] Starting dynamic subtest: rcs0
[227.051638] Dynamic subtest rcs0: SUCCESS (0.000s)
[227.053196] Subtest invalid: SUCCESS (0.006s)
[227.121218] [063/131] (804s left) kms_cursor_edge_walk (64x64-left-edge)
[227.465337] Starting subtest: 64x64-left-edge
[227.466998] Starting dynamic subtest: pipe-A-HDMI-A-1
[230.923633] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (3.459s)
[230.937084] Starting dynamic subtest: pipe-B-HDMI-A-1
[234.255983] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (3.329s)
[234.257547] Subtest 64x64-left-edge: SUCCESS (6.792s)
[234.798033] [064/131] (796s left) gem_wait (wait)
[234.876096] Starting subtest: wait
[234.877834] Starting dynamic subtest: all-engines
[235.895493] Dynamic subtest all-engines: SUCCESS (1.018s)
[235.909554] Starting dynamic subtest: rcs0
[236.919077] Dynamic subtest rcs0: SUCCESS (1.019s)
[236.931497] Starting dynamic subtest: bcs0
[237.938186] Dynamic subtest bcs0: SUCCESS (1.018s)
[237.952804] Starting dynamic subtest: vcs0
[238.969550] Dynamic subtest vcs0: SUCCESS (1.028s)
[238.971509] Subtest wait: SUCCESS (4.094s)
[239.191975] [065/131] (792s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite)
[239.557644] Starting subtest: fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite
[239.561087] Subtest fbcpsr-1p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[239.990146] [066/131] (791s left) gem_mmap (basic)
[240.051965] Starting subtest: basic
[240.062061] Subtest basic: SUCCESS (0.000s)
[240.154627] [067/131] (791s left) kms_atomic (plane-primary-overlay-mutable-zpos)
[240.512451] Starting subtest: plane-primary-overlay-mutable-zpos
[240.785492] Subtest plane-primary-overlay-mutable-zpos: SKIP (0.272s)
[241.401710] [068/131] (790s left) kms_flip (2x-blocking-wf_vblank)
[241.763963] Starting subtest: 2x-blocking-wf_vblank
[241.768198] Starting dynamic subtest: AB-VGA1-HDMI-A1
[272.490909] Dynamic subtest AB-VGA1-HDMI-A1: SUCCESS (30.724s)
[272.492852] Subtest 2x-blocking-wf_vblank: SUCCESS (30.728s)
[273.153246] [069/131] (758s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-cur-indfb-draw-mmap-cpu)
[273.515146] Starting subtest: fbc-2p-scndscrn-cur-indfb-draw-mmap-cpu
[273.518309] Subtest fbc-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[273.944855] [070/131] (757s left) sw_sync (sync_expired_merge)
[274.009463] Starting subtest: sync_expired_merge
[275.084961] Subtest sync_expired_merge: SUCCESS (1.074s)
[275.157797] [071/131] (756s left) kms_plane_lowres (tiling-y)
[275.510313] Starting subtest: tiling-y
[275.514605] Subtest tiling-y: SKIP (0.000s)
[275.959670] [072/131] (755s left) sw_sync (sync_merge_invalid)
[276.015921] Starting subtest: sync_merge_invalid
[276.021949] Subtest sync_merge_invalid: SUCCESS (0.004s)
[276.088474] [073/131] (755s left) gem_wait (invalid-flags)
[276.151080] Starting subtest: invalid-flags
[276.152735] Subtest invalid-flags: SUCCESS (0.000s)
[276.392477] [074/131] (755s left) gem_mmap_gtt (basic-copy)
[276.455227] Starting subtest: basic-copy
[276.667544] Subtest basic-copy: SUCCESS (0.213s)
[276.791209] [075/131] (755s left) gem_caching (writes)
[276.851408] Starting subtest: writes
[279.802029] Subtest writes: SUCCESS (2.952s)
[279.918730] [076/131] (752s left) gem_mmap_wc (bad-offset)
[280.003592] Starting subtest: bad-offset
[280.005408] Subtest bad-offset: SUCCESS (0.000s)
[280.116822] [077/131] (751s left) gem_userptr_blits (huge-split)
[280.202405] Starting subtest: huge-split
[280.206625] Subtest huge-split: SUCCESS (0.004s)
[280.331440] [078/131] (751s left) syncobj_timeline (32bits-limit)
[280.396260] Starting subtest: 32bits-limit
[280.397873] Subtest 32bits-limit: SUCCESS (0.001s)
[280.500403] [079/131] (751s left) kms_ccs (bad-aux-stride-4-tiled-mtl-rc-ccs-cc)
[280.560390] Subtest bad-aux-stride-4-tiled-mtl-rc-ccs-cc: SKIP (0.000s)
[280.629618] [080/131] (751s left) kms_psr2_su (frontbuffer-xrgb8888)
[280.688617] Subtest frontbuffer-XRGB8888: SKIP (0.000s)
[280.744092] [081/131] (751s left) i915_pm_rpm (gem-evict-pwrite)
[292.339962] Subtest gem-evict-pwrite: SKIP (0.000s)
[292.565931] [082/131] (739s left) gem_exec_nop (basic-parallel)
[292.631784] Starting subtest: basic-parallel
[295.439102] Subtest basic-parallel: SUCCESS (2.805s)
[295.663885] [083/131] (736s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-blt)
[296.033699] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-blt
[296.036902] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-blt: SKIP (0.000s)
[296.475845] [084/131] (735s left) gem_eio (in-flight-1us)
[296.542555] Starting subtest: in-flight-1us
[298.028487] Subtest in-flight-1us: SUCCESS (1.486s)
[298.777521] [FACT gem_eio (in-flight-1us)] new: kernel.kmod_is_loaded.vgem: true
[298.782526] [085/131] (733s left) gem_exec_endless (dispatch)
[298.862616] Subtest dispatch: SKIP (0.000s)
[298.947240] [086/131] (733s left) api_intel_bb (misplaced-blitter)
[299.006385] Starting subtest: misplaced-blitter
[299.007978] Subtest misplaced-blitter: SUCCESS (0.002s)
[299.152136] [087/131] (733s left) gem_flink_basic (basic)
[299.212901] Starting subtest: basic
[299.214749] Subtest basic: SUCCESS (0.000s)
[299.324734] [088/131] (733s left) gem_ctx_persistence (smoketest)
[299.387203] Subtest smoketest: SKIP (0.000s)
[299.459807] [089/131] (733s left) kms_dirtyfb (psr-dirtyfb-ioctl)
[299.817795] Starting subtest: psr-dirtyfb-ioctl
[299.824241] Subtest psr-dirtyfb-ioctl: SKIP (0.000s)
[300.260656] [090/131] (732s left) kms_cursor_legacy (cursora-vs-flipa-varying-size)
[300.625890] Starting subtest: cursorA-vs-flipA-varying-size
[311.569496] Subtest cursorA-vs-flipA-varying-size: SUCCESS (10.944s)
[312.130746] [091/131] (720s left) kms_psr_stress_test (invalidate-primary-flip-overlay)
[312.192258] Subtest invalidate-primary-flip-overlay: SKIP (0.000s)
[312.268296] [092/131] (720s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu)
[312.633687] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu
[312.637267] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu: SKIP (0.000s)
[313.072485] [093/131] (719s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted)
[313.138093] Starting subtest: invalid-multi-wait-all-unsubmitted
[313.139831] Subtest invalid-multi-wait-all-unsubmitted: SUCCESS (0.000s)
[313.234388] [094/131] (719s left) prime_busy (hang-wait)
[313.297690] Starting subtest: hang-wait
[313.299585] Starting dynamic subtest: rcs0
[318.896811] Dynamic subtest rcs0: SUCCESS (5.598s)
[318.912060] Starting dynamic subtest: bcs0
[324.860190] Dynamic subtest bcs0: SUCCESS (5.948s)
[324.872344] Starting dynamic subtest: vcs0
[330.864717] Dynamic subtest vcs0: SUCCESS (6.014s)
[330.866384] Subtest hang-wait: SUCCESS (17.566s)
[330.986425] [095/131] (701s left) gem_sync (basic-each)
[331.057956] Starting subtest: basic-each
[333.169184] Subtest basic-each: SUCCESS (2.110s)
[333.383843] [096/131] (699s left) gem_exec_balancer (parallel-keep-in-fence)
[333.445158] Subtest parallel-keep-in-fence: SKIP (0.000s)
[333.548811] [097/131] (699s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip)
[333.913338] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip
[333.916718] Subtest yf-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SKIP (0.000s)
[334.364636] [098/131] (698s left) kms_big_fb (linear-32bpp-rotate-90)
[334.730438] Starting subtest: linear-32bpp-rotate-90
[334.742066] Subtest linear-32bpp-rotate-90: SKIP (0.010s)
[335.198383] [099/131] (698s left) gem_render_copy (yf-tiled-to-vebox-y-tiled)
[335.261530] Starting subtest: yf-tiled-to-vebox-y-tiled
[335.265372] Subtest yf-tiled-to-vebox-y-tiled: SKIP (0.000s)
[335.481483] [100/131] (697s left) kms_hdr (static-swap)
[335.848887] Starting subtest: static-swap
[335.853898] Subtest static-swap: SKIP (0.000s)
[336.292406] [101/131] (697s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-onoff)
[336.658389] Starting subtest: psr-2p-scndscrn-spr-indfb-onoff
[336.661642] Subtest psr-2p-scndscrn-spr-indfb-onoff: SKIP (0.000s)
[337.107683] [102/131] (696s left) kms_big_fb (x-tiled-64bpp-rotate-270)
[337.472784] Starting subtest: x-tiled-64bpp-rotate-270
[337.487130] Subtest x-tiled-64bpp-rotate-270: SKIP (0.012s)
[337.943131] [103/131] (695s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-render)
[338.306242] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-render
[338.309394] Subtest fbc-2p-primscrn-cur-indfb-draw-render: SKIP (0.000s)
[338.741845] [104/131] (694s left) gem_exec_reloc (basic-cpu-wc)
[338.807076] Starting subtest: basic-cpu-wc
[338.810969] Subtest basic-cpu-wc: SUCCESS (0.003s)
[339.548741] [105/131] (694s left) kms_big_fb (y-tiled-64bpp-rotate-180)
[339.922369] Starting subtest: y-tiled-64bpp-rotate-180
[339.925360] Subtest y-tiled-64bpp-rotate-180: SKIP (0.000s)
[340.365266] [106/131] (693s left) kms_flip (2x-flip-vs-suspend-interruptible)
[340.727958] Starting subtest: 2x-flip-vs-suspend-interruptible
[340.732169] Starting dynamic subtest: AB-VGA1-HDMI-A1
[545.326429] Per-test timeout exceeded. Killing the current test with SIGQUIT.
[553.248060] Closing watchdogs
[553.254032] Initializing watchdogs
[553.254102]   /dev/watchdog0
[553.284419] [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)
[553.296029] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[553.297643] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[553.298375] [FACT before any test] new: kernel.kmod_is_loaded.vgem: true
[553.303011] [107/131] (487s left) kms_psr (pr-primary-mmap-gtt)
[553.682254] Subtest pr-primary-mmap-gtt: SKIP (0.000s)
[553.953862] [108/131] (486s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-onoff)
[554.321948] Starting subtest: fbc-2p-primscrn-cur-indfb-onoff
[554.325376] Subtest fbc-2p-primscrn-cur-indfb-onoff: SKIP (0.000s)
[554.772508] [109/131] (486s left) dumb_buffer (map-valid)
[554.839931] Starting subtest: map-valid
[554.841531] Subtest map-valid: SUCCESS (0.000s)
[554.956316] [110/131] (486s left) gem_pxp (regular-baseline-src-copy-readible)
[557.565300] Starting subtest: regular-baseline-src-copy-readible
[557.568866] Subtest regular-baseline-src-copy-readible: SKIP (0.000s)
[557.679312] [111/131] (483s left) syncobj_wait (multi-wait-for-submit-submitted)
[557.748750] Starting subtest: multi-wait-for-submit-submitted
[557.852791] Subtest multi-wait-for-submit-submitted: SUCCESS (0.102s)
[557.973073] [112/131] (483s left) kms_psr2_sf (pr-cursor-plane-move-continuous-sf)
[558.340321] Subtest pr-cursor-plane-move-continuous-sf: SKIP (0.000s)
[558.597733] [113/131] (482s left) kms_flip_scaled_crc (flip-64bpp-yftile-to-32bpp-yftile-downscaling)
[558.657818] Subtest flip-64bpp-yftile-to-32bpp-yftile-downscaling: SKIP (0.000s)
[558.721653] [114/131] (482s left) gem_create (create-massive)
[558.779943] Starting subtest: create-massive
[558.781636] Subtest create-massive: SUCCESS (0.000s)
[559.005607] [115/131] (482s left) syncobj_timeline (invalid-signal-illegal-point)
[559.065145] Starting subtest: invalid-signal-illegal-point
[559.067050] Subtest invalid-signal-illegal-point: SUCCESS (0.000s)
[559.166902] [116/131] (482s left) kms_ccs (missing-ccs-buffer-4-tiled-mtl-mc-ccs)
[559.226937] Subtest missing-ccs-buffer-4-tiled-mtl-mc-ccs: SKIP (0.000s)
[559.300420] [117/131] (482s left) kms_frontbuffer_tracking (psr-2p-primscrn-shrfb-plflip-blt)
[559.678771] Starting subtest: psr-2p-primscrn-shrfb-plflip-blt
[559.682377] Subtest psr-2p-primscrn-shrfb-plflip-blt: SKIP (0.000s)
[560.139403] [118/131] (481s left) kms_addfb_basic (bad-pitch-32)
[560.201039] Starting subtest: bad-pitch-32
[560.203217] Subtest bad-pitch-32: SUCCESS (0.000s)
[560.956015] [119/131] (480s left) syncobj_wait (invalid-single-wait-all-unsubmitted)
[561.015143] Starting subtest: invalid-single-wait-all-unsubmitted
[561.016912] Subtest invalid-single-wait-all-unsubmitted: SUCCESS (0.000s)
[561.124885] [120/131] (480s left) kms_joiner (invalid-modeset-big-joiner)
[561.485254] Starting subtest: invalid-modeset-big-joiner
[561.488397] Subtest invalid-modeset-big-joiner: SKIP (0.000s)
[561.930136] [121/131] (479s left) i915_drm_fdinfo (virtual-busy-idle-all)
[562.000518] Subtest virtual-busy-idle-all: SKIP (0.000s)
[562.065211] [122/131] (479s left) gem_exec_async (concurrent-writes)
[562.132319] Starting subtest: concurrent-writes
[562.134068] Starting dynamic subtest: rcs0
[562.135902] Dynamic subtest rcs0: SUCCESS (0.002s)
[562.153361] Starting dynamic subtest: bcs0
[562.155148] Dynamic subtest bcs0: SUCCESS (0.001s)
[562.172690] Starting dynamic subtest: vcs0
[562.174444] Dynamic subtest vcs0: SUCCESS (0.002s)
[562.176178] Subtest concurrent-writes: SUCCESS (0.009s)
[562.395988] [123/131] (479s left) gem_exec_reloc (basic-cpu-gtt-noreloc)
[562.456400] Starting subtest: basic-cpu-gtt-noreloc
[562.460517] Subtest basic-cpu-gtt-noreloc: SUCCESS (0.003s)
[563.222492] [124/131] (478s left) kms_flip (absolute-wf_vblank-interruptible)
[563.590728] Starting subtest: absolute-wf_vblank-interruptible
[563.592334] Starting dynamic subtest: A-VGA1
[571.392663] Dynamic subtest A-VGA1: SUCCESS (7.750s)
[571.411210] Starting dynamic subtest: B-VGA1
[579.120485] Dynamic subtest B-VGA1: SUCCESS (7.705s)
[579.137768] Starting dynamic subtest: A-HDMI-A1
[587.026368] Dynamic subtest A-HDMI-A1: SUCCESS (7.893s)
[587.041430] Starting dynamic subtest: B-HDMI-A1
[594.946085] Dynamic subtest B-HDMI-A1: SUCCESS (7.914s)
[594.948333] Subtest absolute-wf_vblank-interruptible: SUCCESS (31.274s)
[595.580923] [125/131] (446s left) perf (gen12-group-exclusive-stream-sample-oa)
[595.726277] Subtest gen12-group-exclusive-stream-sample-oa: SKIP (0.000s)
[595.810229] [126/131] (446s left) gem_mmap_gtt (cpuset-basic-small-copy-xy)
[595.878623] Starting subtest: cpuset-basic-small-copy-XY
[596.881477] Subtest cpuset-basic-small-copy-XY: SUCCESS (1.005s)
[597.019272] [127/131] (445s left) kms_chamelium_edid (dp-edid-read)
[597.548374] Subtest dp-edid-read: SKIP (0.000s)
[597.902521] [128/131] (444s left) gem_userptr_blits (unsync-unmap-cycles)
[597.967219] Subtest unsync-unmap-cycles: SKIP (0.000s)
[598.117540] [129/131] (444s left) gem_ctx_persistence (heartbeat-hostile)
[598.179464] Subtest heartbeat-hostile: SKIP (0.000s)
[598.261986] [130/131] (444s left) kms_content_protection (atomic-dpms)
[598.653976] Starting subtest: atomic-dpms
[598.887885] Subtest atomic-dpms: SKIP (0.231s)
[599.535664] [131/131] (442s left) kms_ccs (bad-rotation-90-y-tiled-gen12-rc-ccs)
[599.598727] Subtest bad-rotation-90-y-tiled-gen12-rc-ccs: SKIP (0.000s)
[599.658603] Closing watchdogs
results: parsing output: 0/ for test: kms_cursor_legacy
results: parsing output: 1/ for test: kms_chamelium_audio
results: parsing output: 2/ for test: kms_frontbuffer_tracking
results: parsing output: 3/ for test: kms_busy
results: parsing output: 4/ for test: kms_vblank
results: parsing output: 5/ for test: gem_readwrite
results: parsing output: 6/ for test: kms_cursor_crc
results: parsing output: 7/ for test: i915_pm_rps
results: parsing output: 8/ for test: kms_color
results: parsing output: 9/ for test: kms_async_flips
results: parsing output: 10/ for test: gen9_exec_parse
results: parsing output: 11/ for test: kms_psr2_sf
results: parsing output: 12/ for test: perf
results: parsing output: 13/ for test: kms_pm_backlight
results: parsing output: 14/ for test: kms_frontbuffer_tracking
results: parsing output: 15/ for test: gem_exec_schedule
results: parsing output: 16/ for test: kms_pm_rpm
results: parsing output: 17/ for test: core_setmaster
results: parsing output: 18/ for test: gem_busy
results: parsing output: 19/ for test: gem_exec_schedule
results: parsing output: 20/ for test: syncobj_wait
results: parsing output: 21/ for test: kms_plane_scaling
results: parsing output: 22/ for test: kms_cursor_crc
results: parsing output: 23/ for test: kms_cursor_legacy
results: parsing output: 24/ for test: kms_psr
results: parsing output: 25/ for test: kms_addfb_basic
results: parsing output: 26/ for test: kms_psr
results: parsing output: 27/ for test: gem_lmem_swapping
results: parsing output: 28/ for test: gem_softpin
results: parsing output: 29/ for test: kms_frontbuffer_tracking
results: parsing output: 30/ for test: syncobj_timeline
results: parsing output: 31/ for test: kms_frontbuffer_tracking
results: parsing output: 32/ for test: gem_exec_gttfill
results: parsing output: 33/ for test: gem_exec_params
results: parsing output: 34/ for test: gem_exec_params
results: parsing output: 35/ for test: api_intel_allocator
results: parsing output: 36/ for test: gem_exec_whisper
results: parsing output: 37/ for test: syncobj_timeline
results: parsing output: 38/ for test: kms_ccs
results: parsing output: 39/ for test: kms_frontbuffer_tracking
results: parsing output: 40/ for test: kms_frontbuffer_tracking
results: parsing output: 41/ for test: kms_pm_rpm
results: parsing output: 42/ for test: kms_vrr
results: parsing output: 43/ for test: gem_ppgtt
results: parsing output: 44/ for test: gem_exec_flush
results: parsing output: 45/ for test: kms_frontbuffer_tracking
results: parsing output: 46/ for test: kms_chamelium_hpd
results: parsing output: 47/ for test: kms_addfb_basic
results: parsing output: 48/ for test: kms_big_fb
results: parsing output: 49/ for test: kms_frontbuffer_tracking
results: parsing output: 50/ for test: gem_exec_store
results: parsing output: 51/ for test: gem_exec_reloc
results: parsing output: 52/ for test: syncobj_wait
results: parsing output: 53/ for test: gem_eio
results: parsing output: 54/ for test: perf_pmu
results: parsing output: 55/ for test: kms_flip_scaled_crc
results: parsing output: 56/ for test: kms_psr
results: parsing output: 57/ for test: kms_frontbuffer_tracking
results: parsing output: 58/ for test: kms_legacy_colorkey
results: parsing output: 59/ for test: prime_mmap_coherency
results: parsing output: 60/ for test: kms_addfb_basic
results: parsing output: 61/ for test: sysfs_heartbeat_interval
results: parsing output: 62/ for test: kms_cursor_edge_walk
results: parsing output: 63/ for test: gem_wait
results: parsing output: 64/ for test: kms_frontbuffer_tracking
results: parsing output: 65/ for test: gem_mmap
results: parsing output: 66/ for test: kms_atomic
results: parsing output: 67/ for test: kms_flip
results: parsing output: 68/ for test: kms_frontbuffer_tracking
results: parsing output: 69/ for test: sw_sync
results: parsing output: 70/ for test: kms_plane_lowres
results: parsing output: 71/ for test: sw_sync
results: parsing output: 72/ for test: gem_wait
results: parsing output: 73/ for test: gem_mmap_gtt
results: parsing output: 74/ for test: gem_caching
results: parsing output: 75/ for test: gem_mmap_wc
results: parsing output: 76/ for test: gem_userptr_blits
results: parsing output: 77/ for test: syncobj_timeline
results: parsing output: 78/ for test: kms_ccs
results: parsing output: 79/ for test: kms_psr2_su
results: parsing output: 80/ for test: i915_pm_rpm
results: parsing output: 81/ for test: gem_exec_nop
results: parsing output: 82/ for test: kms_frontbuffer_tracking
results: parsing output: 83/ for test: gem_eio
results: parsing output: 84/ for test: gem_exec_endless
results: parsing output: 85/ for test: api_intel_bb
results: parsing output: 86/ for test: gem_flink_basic
results: parsing output: 87/ for test: gem_ctx_persistence
results: parsing output: 88/ for test: kms_dirtyfb
results: parsing output: 89/ for test: kms_cursor_legacy
results: parsing output: 90/ for test: kms_psr_stress_test
results: parsing output: 91/ for test: kms_frontbuffer_tracking
results: parsing output: 92/ for test: syncobj_timeline
results: parsing output: 93/ for test: prime_busy
results: parsing output: 94/ for test: gem_sync
results: parsing output: 95/ for test: gem_exec_balancer
results: parsing output: 96/ for test: kms_big_fb
results: parsing output: 97/ for test: kms_big_fb
results: parsing output: 98/ for test: gem_render_copy
results: parsing output: 99/ for test: kms_hdr
results: parsing output: 100/ for test: kms_frontbuffer_tracking
results: parsing output: 101/ for test: kms_big_fb
results: parsing output: 102/ for test: kms_frontbuffer_tracking
results: parsing output: 103/ for test: gem_exec_reloc
results: parsing output: 104/ for test: kms_big_fb
results: parsing output: 105/ for test: kms_flip
results: parsing output: 106/ for test: kms_psr
results: parsing output: 107/ for test: kms_frontbuffer_tracking
results: parsing output: 108/ for test: dumb_buffer
results: parsing output: 109/ for test: gem_pxp
results: parsing output: 110/ for test: syncobj_wait
results: parsing output: 111/ for test: kms_psr2_sf
results: parsing output: 112/ for test: kms_flip_scaled_crc
results: parsing output: 113/ for test: gem_create
results: parsing output: 114/ for test: syncobj_timeline
results: parsing output: 115/ for test: kms_ccs
results: parsing output: 116/ for test: kms_frontbuffer_tracking
results: parsing output: 117/ for test: kms_addfb_basic
results: parsing output: 118/ for test: syncobj_wait
results: parsing output: 119/ for test: kms_joiner
results: parsing output: 120/ for test: i915_drm_fdinfo
results: parsing output: 121/ for test: gem_exec_async
results: parsing output: 122/ for test: gem_exec_reloc
results: parsing output: 123/ for test: kms_flip
results: parsing output: 124/ for test: perf
results: parsing output: 125/ for test: gem_mmap_gtt
results: parsing output: 126/ for test: kms_chamelium_edid
results: parsing output: 127/ for test: gem_userptr_blits
results: parsing output: 128/ for test: gem_ctx_persistence
results: parsing output: 129/ for test: kms_content_protection
results: parsing output: 130/ for test: kms_ccs
Done.