nvaccess / nvda

NVDA, the free and open source Screen Reader for Microsoft Windows
https://www.nvaccess.org/
Other
2.12k stars 637 forks source link

UIA in Console and WSL: crashes in some contexts #11428

Closed AAClause closed 3 years ago

AAClause commented 4 years ago

Steps to reproduce:

Unfortunately I don't have a precise scenario. The bug is random but it sometimes occurs when I want to edit a file (with nano for instance).

Actual behavior:

The following traceback is raised in the log and WSL/cmd sometimes crash completely (window is closed):

ERROR - eventHandler.executeEvent (08:57:52.084) - MainThread (14160):
error executing event: caret on <NVDAObjects.Dynamic_WinConsoleUIAEditableTextWithAutoSelectDetectionUIA object at 0x045C7670> with extra args of {}
Traceback (most recent call last):
  File "eventHandler.pyc", line 214, in executeEvent
  File "eventHandler.pyc", line 94, in __init__
  File "eventHandler.pyc", line 102, in next
  File "NVDAObjects\behaviors.pyc", line 191, in event_caret
  File "editableText.pyc", line 343, in detectPossibleSelectionChange
  File "editableText.pyc", line 350, in _updateSelectionAnchor
  File "NVDAObjects\UIA\__init__.pyc", line 776, in compareEndPoints
  File "comtypesMonkeyPatches.pyc", line 26, in __call__
_ctypes.COMError: (-2147467259, ''Unspecified error', (None, None, None, 0, None))

Expected behavior:

No such crash

System configuration

NVDA installed/portable/running from source:

Installed

NVDA version:

alpha-20601,3a9484fb

Windows version:

10 Insider (64-bit) build 20175.1000

Name and version of other software in use when reproducing the issue:

WSL

Other information about your system:

Other questions

Does the issue still occur after restarting your computer?

Yes

Have you tried any other versions of NVDA? If so, please report their behaviors.

Yes, the bug is present since UIA was introduced in Windows Console. I don't usually use UIA in Windows Console because I can't accept such bugs, I've just retested it.

If addons are disabled, is your problem still occuring?

Yes

Did you try to run the COM registry fixing tool in NVDA menu / tools?

Yes

CC @codeofdusk

codeofdusk commented 4 years ago

Probably microsoft/terminal#6986

Neurrone commented 4 years ago

I encountered something similar today, but I'm not sure if the underlying cause is the same because my keyboard and NVDA locked up so badly that I was forced to do a hard reboot, losing unsaved files in the process.

I was interacting with the console via WSL 1 and the command was just a curl which did not produce a lot of output. Unfortunately, NVDA just stopped speaking and most keyboard commands wouldn't work so I couldn't recover at all. This occured right after I pressed enter to execute the command so I'm fairly sure this is a problem with NVDA.

codeofdusk commented 4 years ago

Inbox console recently received some UIA fixes (notably microsoft/terminal#7530). Could you please re-test on the latest insider dev build (or download OpenConsole.exe from the terminal repo by extracting it from the msix)?

AAClause commented 4 years ago

@codeofdusk thanks for the information. Unfortunately my WSL is currently broken due to https://github.com/microsoft/WSL/issues/5902 I'll retry ASAP.

codeofdusk commented 4 years ago

I suspect that microsoft/terminal#7677 will fix many of the remaining crashes.

codeofdusk commented 4 years ago

Could users experiencing this issue please test the OpenConsole.exe in this build with UIA console enabled and report back? On my system, I'm running OpenConsole as the default (follow the steps in microsoft/terminal#1817, and note that you'll also need to take ownership of conhost.exe in advanced security properties before adding/changing permissions), but you can also just run this build for testing while leaving your default console untouched.

codeofdusk commented 4 years ago

Also CC @carlos-zamora (Microsoft dev), @DHowett (Microsoft dev lead), and @simon818 (user who reported some crashes to me directly).

Adriani90 commented 4 years ago

cc: @derekriemer, @josephsl

AAClause commented 4 years ago

I get the following traceback with NVDA version alpha-21096,c61eb42d and Windows 10 Insider (64-bit) build 20226.1000 when I open a file with nano (addons disabled):

Traceback (most recent call last):
  File "eventHandler.pyc", line 220, in executeEvent
  File "eventHandler.pyc", line 96, in __init__
  File "eventHandler.pyc", line 105, in next
  File "NVDAObjects\behaviors.pyc", line 197, in event_caret
  File "editableText.pyc", line 348, in detectPossibleSelectionChange
  File "editableText.pyc", line 355, in _updateSelectionAnchor
  File "NVDAObjects\UIA\__init__.pyc", line 776, in compareEndPoints
  File "comtypesMonkeyPatches.pyc", line 26, in __call__
_ctypes.COMError: (-2147467259, 'Unspecified error', (None, None, None, 0, None))
codeofdusk commented 4 years ago

I'm assuming that NVDA/the console continues working normally though? If so, this will be fixed in #11039.

AAClause commented 4 years ago

@codeofdusk yes apart this traceback, no problem.

codeofdusk commented 4 years ago

Assuming the crash has been resolved, could this issue please be closed?

AAClause commented 4 years ago

I've just reproduced the original issue (one of my instance of cmd crashed completely during a compilation through a SSH connection). So the issue doesn't seem fully solved yet. However I used UIA in Windows Consoles intensely these last days and it's the first crash. (alpha-21126,7df2560a, Windows 10 Insider (64-bit) build 20231.1000)

codeofdusk commented 4 years ago

That's not good. CC @carlos-zamora.

codeofdusk commented 4 years ago

@andre9642 Could you please respond to this issue? The Windows bug deadline is fast approaching and Microsoft would like to fix any remaining crash bugs. Thanks.

AAClause commented 4 years ago

@codeofdusk unfortunately the bug is very rarely (only occurred 2 times last week with an intensive usage of cmd). So I'm unable to reproduce it on request. I remember that I used SSH, Emacs and nano during these 'cmd.exe' instances. Besides these instances were open for several hours (at least 5). Sorry, I can't give more detail for now.

codeofdusk commented 4 years ago

OK, so you were using the cmd included with Windows? Or my test build?

AAClause commented 4 years ago

Yes, the cmd included with Windows. I'll try with your test build soon.

codeofdusk commented 4 years ago

OK, thanks for letting me know.

Inbox is a little behind, there were a few more crashes solved since the latest console in Windows, so I suspect it has been fixed. It's just a matter of waiting for you to receive the fix in a future build.

AAClause commented 4 years ago

@codeofdusk Thanks for this precision. I'm sorry for not testing OpenConsole before. So I consider that this issue is solved. Thanks for your great job with @carlos-zamora! :-)

codeofdusk commented 4 years ago

Windows insider build 20236 contains many additional crash fixes!

akash07k commented 4 years ago

I can't find anything related to the crashes in regards to Console in the change log of 20236?

On 10/15/2020 2:17 AM, Bill Dengler wrote:

Windows insider build 20236 https://blogs.windows.com/windows-insider/2020/10/14/announcing-windows-10-insider-preview-build-20236/ contains many additional crash fixes!

β€” You are receiving this because you are subscribed to this thread. Reply to this email directly, view it on GitHub https://github.com/nvaccess/nvda/issues/11428#issuecomment-708651253, or unsubscribe https://github.com/notifications/unsubscribe-auth/ABQWBM6BZRXBHDCJ7QAVNLLSKYE7PANCNFSM4PIPK3EA.

DHowett commented 4 years ago

@akash07k if we put every team's changes in the changelog, people would stop reading after the first 500! I integrated these changes from our open-source version myself. They're definitely there! πŸ˜„

akash07k commented 4 years ago

Yes bro, you are absolutely right. So, is there any way/path where we can read all the change log of every time/component of every latest insider windows release?

@akash07k if we put every team's changes in the changelog, people would stop reading after the first 500! I integrated these changes from our open-source version myself. They're definitely there! πŸ˜„

josephsl commented 4 years ago

Hi, I’m thinking not, as engineers need to balance between publishing really technical information that is passed amongst team members, among multiple teams, and the organization as a whole versus highlighting very high impact changes that will be (and can be) noticed by new users or seasoned Insiders. Besides, there are hundreds of Git branches used inside Windows organization at Microsoft, along with some of them having features on or off, all of which will be merged into a single rsprerelease branch every day at Microsoft. Add it to the fact that more branches exist to service six versions of Windows10 (th1 for 1507, rs1release for 1607, rs4release for 1803, rs5release for 1809, 19h1release for 190x, vbrelease for 20Hx), some of which contribute to WIP builds in one way or another, and you get the idea. Thanks.

From: Akash Kakkar notifications@github.com Sent: Wednesday, October 14, 2020 11:05 PM To: nvaccess/nvda nvda@noreply.github.com Cc: Joseph Lee joseph.lee22590@gmail.com; Mention mention@noreply.github.com Subject: Re: [nvaccess/nvda] UIA in Console and WSL: crashes in some contexts (#11428)

Yes bro, you are absolutely right. So, is there any way/path where we can read all the change log of every time/component of every latest insider windows release?

@akash07k https://github.com/akash07k if we put every team's changes in the changelog, people would stop reading after the first 500! I integrated these changes from our open-source version myself. They're definitely there! πŸ˜„

β€” You are receiving this because you were mentioned. Reply to this email directly, view it on GitHub https://github.com/nvaccess/nvda/issues/11428#issuecomment-708919702 , or unsubscribe https://github.com/notifications/unsubscribe-auth/AB4AXEDKI5IJBBOFAH5LOGTSK2GKHANCNFSM4PIPK3EA .

akash07k commented 4 years ago

Thanks Joseph, You're right. Publishing every change log can be quite complicated

On 10/15/20, Joseph Lee notifications@github.com wrote:

Hi, I’m thinking not, as engineers need to balance between publishing really technical information that is passed amongst team members, among multiple teams, and the organization as a whole versus highlighting very high impact changes that will be (and can be) noticed by new users or seasoned Insiders. Besides, there are hundreds of Git branches used inside Windows organization at Microsoft, along with some of them having features on or off, all of which will be merged into a single rsprerelease branch every day at Microsoft. Add it to the fact that more branches exist to service six versions of Windows10 (th1 for 1507, rs1release for 1607, rs4release for 1803, rs5release for 1809, 19h1release for 190x, vbrelease for 20Hx), some of which contribute to WIP builds in one way or another, and you get the idea. Thanks.

From: Akash Kakkar notifications@github.com

Sent: Wednesday, October 14, 2020 11:05 PM

To: nvaccess/nvda nvda@noreply.github.com

Cc: Joseph Lee joseph.lee22590@gmail.com; Mention mention@noreply.github.com

Subject: Re: [nvaccess/nvda] UIA in Console and WSL: crashes in some contexts (#11428)

Yes bro, you are absolutely right.

So, is there any way/path where we can read all the change log of every time/component of every latest insider windows release?

@akash07k https://github.com/akash07k if we put every team's changes in the changelog, people would stop reading after the first 500! I integrated these changes from our open-source version myself. They're definitely there! πŸ˜„

β€”

You are receiving this because you were mentioned.

Reply to this email directly, view it on GitHub https://github.com/nvaccess/nvda/issues/11428#issuecomment-708919702 , or unsubscribe https://github.com/notifications/unsubscribe-auth/AB4AXEDKI5IJBBOFAH5LOGTSK2GKHANCNFSM4PIPK3EA .

--

You are receiving this because you were mentioned.

Reply to this email directly or view it on GitHub:

https://github.com/nvaccess/nvda/issues/11428#issuecomment-708924486

AAClause commented 4 years ago

@codeofdusk Today I was able to reproduce the crash 2 times. The second time, I enabled debug mode with UIA events. Not tested with add-ons disabled. I used cmd directly (not openconsole). Here's the log after pressing enter (my command was emacs <file>):

Log (excerpt) ``` Input: kb(laptop):enter DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.361) - MainThread (1268): _getTextWithFieldsForUIARange DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.361) - MainThread (1268): rootElement: document DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.361) - MainThread (1268): full text: DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.362) - MainThread (1268): Fetching parents starting from enclosingElement DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.364) - MainThread (1268): Hit root DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.364) - MainThread (1268): Done fetching parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.364) - MainThread (1268): Generating controlFields for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.364) - MainThread (1268): Done generating controlFields for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.364) - MainThread (1268): Yielding control starts for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.365) - MainThread (1268): Done yielding control starts for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.365) - MainThread (1268): Yielding balanced fields for textRange DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.365) - MainThread (1268): no children DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.365) - MainThread (1268): Yielding text DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.366) - MainThread (1268): _getTextWithFields_text start DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.366) - MainThread (1268): Walking by unit None, with further units of: [1, 2, 0] DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.366) - MainThread (1268): Done _getTextWithFields_text DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.367) - MainThread (1268): _getTextWithFieldsForUIARange end DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.367) - MainThread (1268): _getTextWithFieldsForUIARange DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.367) - MainThread (1268): rootElement: document DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.367) - MainThread (1268): full text: DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.369) - MainThread (1268): Fetching parents starting from enclosingElement DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.370) - MainThread (1268): Hit root DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.370) - MainThread (1268): Done fetching parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.371) - MainThread (1268): Generating controlFields for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.371) - MainThread (1268): Done generating controlFields for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.371) - MainThread (1268): Yielding control starts for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.371) - MainThread (1268): Done yielding control starts for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.372) - MainThread (1268): Yielding balanced fields for textRange DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.372) - MainThread (1268): no children DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.372) - MainThread (1268): Yielding text DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.372) - MainThread (1268): _getTextWithFields_text start DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.373) - MainThread (1268): Walking by unit None, with further units of: [1, 2, 0] DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.373) - MainThread (1268): Done _getTextWithFields_text DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.373) - MainThread (1268): _getTextWithFieldsForUIARange end DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.374) - MainThread (1268): _getTextWithFieldsForUIARange DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.375) - MainThread (1268): rootElement: document DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.376) - MainThread (1268): full text: DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.376) - MainThread (1268): Fetching parents starting from enclosingElement DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.378) - MainThread (1268): Hit root DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.379) - MainThread (1268): Done fetching parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.379) - MainThread (1268): Generating controlFields for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.379) - MainThread (1268): Done generating controlFields for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.379) - MainThread (1268): Yielding control starts for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.379) - MainThread (1268): Done yielding control starts for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.379) - MainThread (1268): Yielding balanced fields for textRange DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.379) - MainThread (1268): no children DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.379) - MainThread (1268): Yielding text DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.380) - MainThread (1268): _getTextWithFields_text start DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.380) - MainThread (1268): Walking by unit None, with further units of: [1, 2, 0] DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.381) - MainThread (1268): Done _getTextWithFields_text DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.381) - MainThread (1268): _getTextWithFieldsForUIARange end DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.381) - MainThread (1268): _getTextWithFieldsForUIARange DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.382) - MainThread (1268): rootElement: document DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.382) - MainThread (1268): full text: DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.383) - MainThread (1268): Fetching parents starting from enclosingElement DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.385) - MainThread (1268): Hit root DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.385) - MainThread (1268): Done fetching parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.385) - MainThread (1268): Generating controlFields for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.385) - MainThread (1268): Done generating controlFields for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.385) - MainThread (1268): Yielding control starts for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.386) - MainThread (1268): Done yielding control starts for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.386) - MainThread (1268): Yielding balanced fields for textRange DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.386) - MainThread (1268): no children DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.386) - MainThread (1268): Yielding text DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.387) - MainThread (1268): _getTextWithFields_text start DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.387) - MainThread (1268): Walking by unit None, with further units of: [1, 2, 0] DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.387) - MainThread (1268): Done _getTextWithFields_text DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.387) - MainThread (1268): _getTextWithFieldsForUIARange end DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.390) - MainThread (1268): _getTextWithFieldsForUIARange DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.390) - MainThread (1268): rootElement: document DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.390) - MainThread (1268): full text: DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.392) - MainThread (1268): Fetching parents starting from enclosingElement DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.393) - MainThread (1268): Hit root DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.393) - MainThread (1268): Done fetching parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.394) - MainThread (1268): Generating controlFields for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.394) - MainThread (1268): Done generating controlFields for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.394) - MainThread (1268): Yielding control starts for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.394) - MainThread (1268): Done yielding control starts for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.395) - MainThread (1268): Yielding balanced fields for textRange DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.395) - MainThread (1268): no children DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.395) - MainThread (1268): Yielding text DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.395) - MainThread (1268): _getTextWithFields_text start DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.396) - MainThread (1268): Walking by unit None, with further units of: [1, 2, 0] DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.396) - MainThread (1268): Chunk has text. Fetching formatting DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.397) - MainThread (1268): Yielding formatting and text DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.397) - MainThread (1268): Done _getTextWithFields_text DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.397) - MainThread (1268): _getTextWithFieldsForUIARange end DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.398) - MainThread (1268): _getTextWithFieldsForUIARange DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.399) - MainThread (1268): rootElement: document DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.399) - MainThread (1268): full text: DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.400) - MainThread (1268): Fetching parents starting from enclosingElement DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.402) - MainThread (1268): Hit root DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.402) - MainThread (1268): Done fetching parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.402) - MainThread (1268): Generating controlFields for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.402) - MainThread (1268): Done generating controlFields for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.403) - MainThread (1268): Yielding control starts for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.403) - MainThread (1268): Done yielding control starts for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.403) - MainThread (1268): Yielding balanced fields for textRange DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.403) - MainThread (1268): no children DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.404) - MainThread (1268): Yielding text DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.404) - MainThread (1268): _getTextWithFields_text start DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.404) - MainThread (1268): Walking by unit None, with further units of: [1, 2, 0] DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.405) - MainThread (1268): Chunk has text. Fetching formatting DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.405) - MainThread (1268): Yielding formatting and text DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.406) - MainThread (1268): Done _getTextWithFields_text DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.406) - MainThread (1268): _getTextWithFieldsForUIARange end IO - braille.BrailleBuffer.update (20:39:25.423) - MainThread (1268): Braille regions text: [' '] IO - braille.BrailleHandler.update (20:39:25.424) - MainThread (1268): Braille window dots: - - - - - - - - - - - - - - - - - - - - - - - - - - - - - - - - - - - - - - - - IO - braille.BrailleHandler.update (20:39:25.425) - MainThread (1268): Braille window dots: - - - - - - - - - - - - - - - - - - - - - - - - - - - - - - - - - - - - - - - - DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.430) - MainThread (1268): _getTextWithFieldsForUIARange DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.431) - MainThread (1268): rootElement: document DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.431) - MainThread (1268): full text: DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.432) - MainThread (1268): Fetching parents starting from enclosingElement DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.434) - MainThread (1268): Hit root DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.434) - MainThread (1268): Done fetching parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.434) - MainThread (1268): Generating controlFields for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.435) - MainThread (1268): Done generating controlFields for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.435) - MainThread (1268): Yielding control starts for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.435) - MainThread (1268): Done yielding control starts for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.435) - MainThread (1268): Yielding balanced fields for textRange DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.435) - MainThread (1268): no children DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.435) - MainThread (1268): Yielding text DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.435) - MainThread (1268): _getTextWithFields_text start DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.435) - MainThread (1268): Walking by unit None, with further units of: [1, 2, 0] DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.436) - MainThread (1268): Done _getTextWithFields_text DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.436) - MainThread (1268): _getTextWithFieldsForUIARange end DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.437) - MainThread (1268): _getTextWithFieldsForUIARange DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.437) - MainThread (1268): rootElement: document DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.438) - MainThread (1268): full text: DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.438) - MainThread (1268): Fetching parents starting from enclosingElement DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.440) - MainThread (1268): Hit root DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.440) - MainThread (1268): Done fetching parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.441) - MainThread (1268): Generating controlFields for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.441) - MainThread (1268): Done generating controlFields for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.441) - MainThread (1268): Yielding control starts for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.441) - MainThread (1268): Done yielding control starts for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.441) - MainThread (1268): Yielding balanced fields for textRange DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.441) - MainThread (1268): no children DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.441) - MainThread (1268): Yielding text DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.441) - MainThread (1268): _getTextWithFields_text start DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.442) - MainThread (1268): Walking by unit None, with further units of: [1, 2, 0] DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.442) - MainThread (1268): Done _getTextWithFields_text DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.442) - MainThread (1268): _getTextWithFieldsForUIARange end DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.444) - MainThread (1268): _getTextWithFieldsForUIARange DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.444) - MainThread (1268): rootElement: document DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.444) - MainThread (1268): full text: DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.445) - MainThread (1268): Fetching parents starting from enclosingElement DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.447) - MainThread (1268): Hit root DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.447) - MainThread (1268): Done fetching parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.447) - MainThread (1268): Generating controlFields for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.447) - MainThread (1268): Done generating controlFields for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.447) - MainThread (1268): Yielding control starts for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.447) - MainThread (1268): Done yielding control starts for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.447) - MainThread (1268): Yielding balanced fields for textRange DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.447) - MainThread (1268): no children DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.448) - MainThread (1268): Yielding text DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.448) - MainThread (1268): _getTextWithFields_text start DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.448) - MainThread (1268): Walking by unit None, with further units of: [1, 2, 0] DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.449) - MainThread (1268): Done _getTextWithFields_text DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.449) - MainThread (1268): _getTextWithFieldsForUIARange end DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.449) - MainThread (1268): _getTextWithFieldsForUIARange DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.450) - MainThread (1268): rootElement: document DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.450) - MainThread (1268): full text: DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.451) - MainThread (1268): Fetching parents starting from enclosingElement DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.453) - MainThread (1268): Hit root DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.453) - MainThread (1268): Done fetching parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.453) - MainThread (1268): Generating controlFields for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.453) - MainThread (1268): Done generating controlFields for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.453) - MainThread (1268): Yielding control starts for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.453) - MainThread (1268): Done yielding control starts for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.453) - MainThread (1268): Yielding balanced fields for textRange DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.453) - MainThread (1268): no children DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.453) - MainThread (1268): Yielding text DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.454) - MainThread (1268): _getTextWithFields_text start DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.454) - MainThread (1268): Walking by unit None, with further units of: [1, 2, 0] DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.455) - MainThread (1268): Done _getTextWithFields_text DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.455) - MainThread (1268): _getTextWithFieldsForUIARange end DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.456) - MainThread (1268): _getTextWithFieldsForUIARange DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.456) - MainThread (1268): rootElement: document DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.457) - MainThread (1268): full text: DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.459) - MainThread (1268): Fetching parents starting from enclosingElement DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.459) - MainThread (1268): Hit root DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.460) - MainThread (1268): Done fetching parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.460) - MainThread (1268): Generating controlFields for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.460) - MainThread (1268): Done generating controlFields for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.460) - MainThread (1268): Yielding control starts for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.461) - MainThread (1268): Done yielding control starts for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.461) - MainThread (1268): Yielding balanced fields for textRange DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.461) - MainThread (1268): no children DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.462) - MainThread (1268): Yielding text DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.462) - MainThread (1268): _getTextWithFields_text start DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.462) - MainThread (1268): Walking by unit None, with further units of: [1, 2, 0] DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.462) - MainThread (1268): Chunk has text. Fetching formatting DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.463) - MainThread (1268): Yielding formatting and text DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.464) - MainThread (1268): Done _getTextWithFields_text DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.464) - MainThread (1268): _getTextWithFieldsForUIARange end DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.464) - MainThread (1268): _getTextWithFieldsForUIARange DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.465) - MainThread (1268): rootElement: document DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.465) - MainThread (1268): full text: DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.466) - MainThread (1268): Fetching parents starting from enclosingElement DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.468) - MainThread (1268): Hit root DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.468) - MainThread (1268): Done fetching parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.468) - MainThread (1268): Generating controlFields for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.469) - MainThread (1268): Done generating controlFields for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.469) - MainThread (1268): Yielding control starts for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.469) - MainThread (1268): Done yielding control starts for parents DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.469) - MainThread (1268): Yielding balanced fields for textRange DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.470) - MainThread (1268): no children DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFieldsForUIARange (20:39:25.470) - MainThread (1268): Yielding text DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.470) - MainThread (1268): _getTextWithFields_text start DEBUG - NVDAObjects.UIA.UIATextInfo._getTextWithFields_text (20:39:25.471) - MainThread (1268): Walking by unit None, with further units of: [1, 2, 0] DEBUG - _UIAHandler.UIAHandler.IUIAutomationPropertyChangedEventHandler_HandlePropertyChangedEvent (20:39:25.567) - Dummy-2 (4712): HandlePropertyChangedEvent: Ignoring event valueChange for shouldAcceptEvent=False DEBUGWARNING - watchdog._watcher (20:39:25.938) - watchdog (7972): Trying to recover from freeze. Listing stacks for Python threads: Python stack for thread 6536 (Dynamic_WinConsoleUIAEditableTextWithAutoSelectDetectionUIA._monitorThread): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "NVDAObjects\behaviors.pyc", line 300, in _monitor File "threading.pyc", line 552, in wait File "threading.pyc", line 296, in wait Python stack for thread 1036 (watchdog.CancellableCallThread.execute(<_FuncPtr object at 0x00F7A6C0>)): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "watchdog.pyc", line 332, in run File "threading.pyc", line 552, in wait File "threading.pyc", line 296, in wait Python stack for thread 7972 (watchdog): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "watchdog.pyc", line 127, in _watcher File "watchdog.pyc", line 63, in getFormattedStacksForAllThreads Python stack for thread 1284 (Thread-3): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "C:\Users\andre\AppData\Roaming\nvda\addons\markdownForever\globalPlugins\markdownForever\updateCheck.py", line 175, in run time.sleep(0.2) Python stack for thread 2908 (winInputHook): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "winInputHook.pyc", line 79, in hookThreadFunc Python stack for thread 14288 (_UIAHandler.UIAHandler.MTAThread): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "_UIAHandler.pyc", line 310, in MTAThreadFunc File "queue.pyc", line 170, in get File "threading.pyc", line 296, in wait Python stack for thread 10576 (braille._BgThread): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "braille.pyc", line 2187, in func Python stack for thread 7744 (Thread-1): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "C:\Users\andre\AppData\Roaming\nvda\addons\codefactory-py3\synthDrivers\_cfnvdainterface.py", line 272, in run func, args, kwargs = _bgQueue.get() File "queue.pyc", line 170, in get File "threading.pyc", line 296, in wait Python stack for thread 1268 (MainThread): File "nvda.pyw", line 236, in File "core.pyc", line 553, in main File "wx\core.pyc", line 2134, in MainLoop File "gui\__init__.pyc", line 1062, in Notify File "core.pyc", line 523, in run File "queueHandler.pyc", line 88, in pumpAll File "queueHandler.pyc", line 55, in flushQueue File "eventHandler.pyc", line 65, in _queueEventCallback File "eventHandler.pyc", line 246, in executeEvent File "eventHandler.pyc", line 96, in __init__ File "eventHandler.pyc", line 105, in next File "NVDAObjects\behaviors.pyc", line 195, in event_caret File "NVDAObjects\__init__.pyc", line 1180, in event_caret File "review.pyc", line 177, in handleCaretMove File "api.pyc", line 215, in setReviewPosition File "braille.pyc", line 2036, in handleReviewMove File "braille.pyc", line 1963, in _doCursorMove File "C:\Users\andre\AppData\Roaming\nvda\addons\BrailleExtender\globalPlugins\brailleExtender\documentFormatting.py", line 249, in update fn(self) File "C:\Users\andre\AppData\Roaming\nvda\addons\BrailleExtender\globalPlugins\brailleExtender\patches.py", line 277, in update_TextInfoRegion self._addTextWithFields(chunk, formatConfig) File "C:\Users\andre\AppData\Roaming\nvda\addons\BrailleExtender\globalPlugins\brailleExtender\documentFormatting.py", line 246, in addTextWithFields_edit fn(self, info, formatConfig_, isSelection) File "C:\Users\andre\AppData\Roaming\nvda\addons\BrailleExtender\globalPlugins\brailleExtender\patches.py", line 713, in _addTextWithFields for command in info.getTextWithFields(formatConfig=formatConfig): File "NVDAObjects\UIA\__init__.pyc", line 718, in getTextWithFields File "NVDAObjects\UIA\__init__.pyc", line 706, in _getTextWithFieldsForUIARange File "NVDAObjects\UIA\__init__.pyc", line 491, in _getTextWithFields_text File "NVDAObjects\UIA\__init__.pyc", line 457, in _getTextFromUIARange File "comtypesMonkeyPatches.pyc", line 26, in __call__ DEBUG - _UIAHandler.UIAHandler.IUIAutomationPropertyChangedEventHandler_HandlePropertyChangedEvent (20:39:26.572) - Dummy-2 (4712): HandlePropertyChangedEvent: Ignoring event valueChange for shouldAcceptEvent=False DEBUG - _UIAHandler.UIAHandler.IUIAutomationPropertyChangedEventHandler_HandlePropertyChangedEvent (20:39:27.576) - Dummy-2 (4712): HandlePropertyChangedEvent: Ignoring event valueChange for shouldAcceptEvent=False ERROR - eventHandler.executeEvent (20:39:27.718) - MainThread (1268): error executing event: caret on with extra args of {} Traceback (most recent call last): File "eventHandler.pyc", line 246, in executeEvent File "eventHandler.pyc", line 96, in __init__ File "eventHandler.pyc", line 105, in next File "NVDAObjects\behaviors.pyc", line 195, in event_caret File "NVDAObjects\__init__.pyc", line 1180, in event_caret File "review.pyc", line 177, in handleCaretMove File "api.pyc", line 215, in setReviewPosition File "braille.pyc", line 2036, in handleReviewMove File "braille.pyc", line 1963, in _doCursorMove File "C:\Users\andre\AppData\Roaming\nvda\addons\BrailleExtender\globalPlugins\brailleExtender\documentFormatting.py", line 249, in update fn(self) File "C:\Users\andre\AppData\Roaming\nvda\addons\BrailleExtender\globalPlugins\brailleExtender\patches.py", line 277, in update_TextInfoRegion self._addTextWithFields(chunk, formatConfig) File "C:\Users\andre\AppData\Roaming\nvda\addons\BrailleExtender\globalPlugins\brailleExtender\documentFormatting.py", line 246, in addTextWithFields_edit fn(self, info, formatConfig_, isSelection) File "C:\Users\andre\AppData\Roaming\nvda\addons\BrailleExtender\globalPlugins\brailleExtender\patches.py", line 713, in _addTextWithFields for command in info.getTextWithFields(formatConfig=formatConfig): File "NVDAObjects\UIA\__init__.pyc", line 718, in getTextWithFields File "NVDAObjects\UIA\__init__.pyc", line 706, in _getTextWithFieldsForUIARange File "NVDAObjects\UIA\__init__.pyc", line 491, in _getTextWithFields_text File "NVDAObjects\UIA\__init__.pyc", line 457, in _getTextFromUIARange File "comtypesMonkeyPatches.pyc", line 26, in __call__ _ctypes.COMError: (-2147418113, 'Catastrophic failure', (None, None, None, 0, None)) DEBUGWARNING - NVDAObjects.IAccessible.IAccessible._get_IAccessibleRole (20:39:27.928) - MainThread (1268): accRole failed: (-2147024809, 'Paramètre incorrect.', (None, None, None, 0, None)) DEBUG - appModuleHandler.cleanup (20:39:27.943) - MainThread (1268): application conhost closed ```

(NVDA alpha-21196,4840e5fb, Windows 10, build 20236)

codeofdusk commented 4 years ago

This is really odd. Can you please test again with add-ons disabled?

(I can run emacs just fine in OpenConsole).

AAClause commented 4 years ago

OK, I'll try this during this weekend. The bug is random. Before the crash I was able open Emacs about 10 times with no issue.

AAClause commented 4 years ago

I can reproduce the issue with Openconsole. Occurred just now (add-ons enabled).

DHowett commented 4 years ago

I apologize -- I miscounted the fixes that went into 20136 and osme of the crash fixes are stuck in a later build.

codeofdusk commented 4 years ago

@Andre9642 This means the crashes have been fixed, but the fixes still aren't available to you. They should come out in another build or two (probably by the end of November) but @DHowett would know more.

AAClause commented 4 years ago

Also, sometimes I get the following error:

ERROR - comtypes._comobject.call_without_this (15:15:19.553) - Dummy-2 (27800):
Exception in IUIAutomationEventHandler.HandleAutomationEvent implementation:
Traceback (most recent call last):
  File "comtypes\_comobject.pyc", line 147, in call_without_this
  File "_UIAHandler.pyc", line 447, in IUIAutomationEventHandler_HandleAutomationEvent
  File "comtypesMonkeyPatches.pyc", line 26, in __call__
_ctypes.COMError: (-2147220991, 'An event was unable to invoke any of the subscribers', (None, None, None, 0, None))
codeofdusk commented 4 years ago

Build 20241 was recently released with additional fixes (confirmed offline with @DHowett).

@Andre9642 Could you please retest on the new build and report back on the crash?

AAClause commented 4 years ago

Unfortunately, the issue is not solved for me. I am able to reproduce it in a few minutes easily now.

Log (snippets) ``` INFO - __main__ (10:50:17.029) - MainThread (16336): Starting NVDA version alpha-21252,111a0f03 [...] INFO - core.main (10:50:19.353) - MainThread (16336): Using Windows version 10.0.20241 workstation [...] INFO - core.main (10:50:19.627) - MainThread (16336): Add-ons are disabled. Restart NVDA to enable them. [...] ERROR - eventHandler.executeEvent (10:51:01.865) - MainThread (16336): error executing event: caret on with extra args of {} Traceback (most recent call last): File "eventHandler.pyc", line 246, in executeEvent File "eventHandler.pyc", line 96, in __init__ File "eventHandler.pyc", line 105, in next File "NVDAObjects\behaviors.pyc", line 195, in event_caret File "NVDAObjects\__init__.pyc", line 1180, in event_caret File "review.pyc", line 177, in handleCaretMove File "api.pyc", line 215, in setReviewPosition File "braille.pyc", line 2036, in handleReviewMove File "braille.pyc", line 1963, in _doCursorMove File "braille.pyc", line 1014, in update File "NVDAObjects\UIA\__init__.pyc", line 789, in setEndPoint File "comtypesMonkeyPatches.pyc", line 26, in __call__ _ctypes.COMError: (-2147467259, 'Unspecified error', (None, None, None, 0, None)) [...] DEBUGWARNING - NVDAObjects.UIA.winConsoleUIA.WinConsoleUIA.detectPossibleSelectionChange (10:51:07.462) - MainThread (16336): Exception raised when comparing selections, probably due to a switch to/from the alt buffer. Traceback (most recent call last): File "NVDAObjects\UIA\winConsoleUIA.pyc", line 382, in detectPossibleSelectionChange File "editableText.pyc", line 348, in detectPossibleSelectionChange File "editableText.pyc", line 355, in _updateSelectionAnchor File "NVDAObjects\UIA\__init__.pyc", line 778, in compareEndPoints File "comtypesMonkeyPatches.pyc", line 26, in __call__ _ctypes.COMError: (-2147467259, 'Unspecified error', (None, None, None, 0, None)) [...] ERROR - eventHandler.executeEvent (10:51:10.886) - MainThread (16336): error executing event: caret on with extra args of {} Traceback (most recent call last): File "eventHandler.pyc", line 246, in executeEvent File "eventHandler.pyc", line 96, in __init__ File "eventHandler.pyc", line 105, in next File "NVDAObjects\behaviors.pyc", line 195, in event_caret File "NVDAObjects\__init__.pyc", line 1180, in event_caret File "review.pyc", line 177, in handleCaretMove File "api.pyc", line 215, in setReviewPosition File "braille.pyc", line 2036, in handleReviewMove File "braille.pyc", line 1963, in _doCursorMove File "braille.pyc", line 1042, in update File "NVDAObjects\UIA\__init__.pyc", line 778, in compareEndPoints File "comtypesMonkeyPatches.pyc", line 26, in __call__ _ctypes.COMError: (-2147467259, 'Unspecified error', (None, None, None, 0, None)) [...] DEBUGWARNING - watchdog._watcher (10:51:22.441) - watchdog (15000): Trying to recover from freeze. Listing stacks for Python threads: Python stack for thread 6512 (Dynamic_WinConsoleUIAEditableTextWithAutoSelectDetectionUIA._monitorThread): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "NVDAObjects\behaviors.pyc", line 312, in _monitor File "NVDAObjects\UIA\winConsoleUIA.pyc", line 371, in _getTextLines File "NVDAObjects\behaviors.pyc", line 276, in _getTextLines File "textInfos\__init__.pyc", line 522, in getTextInChunks File "NVDAObjects\UIA\__init__.pyc", line 778, in compareEndPoints File "comtypesMonkeyPatches.pyc", line 26, in __call__ Python stack for thread 14980 (watchdog.CancellableCallThread.execute()): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "watchdog.pyc", line 332, in run File "threading.pyc", line 552, in wait File "threading.pyc", line 296, in wait Python stack for thread 15000 (watchdog): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "watchdog.pyc", line 127, in _watcher File "watchdog.pyc", line 63, in getFormattedStacksForAllThreads Python stack for thread 14960 (winInputHook): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "winInputHook.pyc", line 79, in hookThreadFunc Python stack for thread 10384 (_UIAHandler.UIAHandler.MTAThread): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "_UIAHandler.pyc", line 310, in MTAThreadFunc File "queue.pyc", line 170, in get File "threading.pyc", line 296, in wait Python stack for thread 8380 (braille._BgThread): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "braille.pyc", line 2187, in func Python stack for thread 16336 (MainThread): File "nvda.pyw", line 236, in File "core.pyc", line 553, in main File "wx\core.pyc", line 2134, in MainLoop File "gui\__init__.pyc", line 1062, in Notify File "core.pyc", line 523, in run File "queueHandler.pyc", line 88, in pumpAll File "queueHandler.pyc", line 55, in flushQueue File "eventHandler.pyc", line 65, in _queueEventCallback File "eventHandler.pyc", line 246, in executeEvent File "eventHandler.pyc", line 96, in __init__ File "eventHandler.pyc", line 105, in next File "NVDAObjects\behaviors.pyc", line 195, in event_caret File "NVDAObjects\__init__.pyc", line 1180, in event_caret File "review.pyc", line 177, in handleCaretMove File "api.pyc", line 215, in setReviewPosition File "braille.pyc", line 2036, in handleReviewMove File "braille.pyc", line 1963, in _doCursorMove File "braille.pyc", line 1016, in update File "braille.pyc", line 854, in _addTextWithFields File "NVDAObjects\UIA\__init__.pyc", line 718, in getTextWithFields File "NVDAObjects\UIA\__init__.pyc", line 706, in _getTextWithFieldsForUIARange File "NVDAObjects\UIA\__init__.pyc", line 491, in _getTextWithFields_text File "NVDAObjects\UIA\__init__.pyc", line 457, in _getTextFromUIARange File "comtypesMonkeyPatches.pyc", line 26, in __call__ DEBUG - _UIAHandler.UIAHandler.IUIAutomationPropertyChangedEventHandler_HandlePropertyChangedEvent (10:51:22.817) - Dummy-2 (5968): HandlePropertyChangedEvent: Ignoring event valueChange for shouldAcceptEvent=False DEBUG - _UIAHandler.UIAHandler.IUIAutomationPropertyChangedEventHandler_HandlePropertyChangedEvent (10:51:23.820) - Dummy-2 (5968): HandlePropertyChangedEvent: Ignoring event valueChange for shouldAcceptEvent=False DEBUG - _UIAHandler.UIAHandler.IUIAutomationPropertyChangedEventHandler_HandlePropertyChangedEvent (10:51:24.845) - Dummy-2 (5968): HandlePropertyChangedEvent: Ignoring event valueChange for shouldAcceptEvent=False DEBUG - _UIAHandler.UIAHandler.IUIAutomationFocusChangedEventHandler_HandleFocusChangedEvent (10:51:25.165) - Dummy-2 (5968): HandleFocusChangedEvent: Ignoring for non native element ERROR - eventHandler.executeEvent (10:51:25.079) - MainThread (16336): error executing event: caret on with extra args of {} Traceback (most recent call last): File "eventHandler.pyc", line 246, in executeEvent File "eventHandler.pyc", line 96, in __init__ File "eventHandler.pyc", line 105, in next File "NVDAObjects\behaviors.pyc", line 195, in event_caret File "NVDAObjects\__init__.pyc", line 1180, in event_caret File "review.pyc", line 177, in handleCaretMove File "api.pyc", line 215, in setReviewPosition File "braille.pyc", line 2036, in handleReviewMove File "braille.pyc", line 1963, in _doCursorMove File "braille.pyc", line 1016, in update File "braille.pyc", line 854, in _addTextWithFields File "NVDAObjects\UIA\__init__.pyc", line 718, in getTextWithFields File "NVDAObjects\UIA\__init__.pyc", line 706, in _getTextWithFieldsForUIARange File "NVDAObjects\UIA\__init__.pyc", line 491, in _getTextWithFields_text File "NVDAObjects\UIA\__init__.pyc", line 457, in _getTextFromUIARange File "comtypesMonkeyPatches.pyc", line 26, in __call__ _ctypes.COMError: (-2147418113, 'Catastrophic Failure', (None, None, None, 0, None)) DEBUGWARNING - NVDAObjects.IAccessible.IAccessible._get_IAccessibleRole (10:51:25.246) - MainThread (16336): accRole failed: (-2147024809, 'The parameter is incorrect.', (None, None, None, 0, None)) DEBUG - appModuleHandler.cleanup (10:51:25.315) - MainThread (16336): application conhost closed ```

Here's what I Did during this NVDA session until the crash:

  1. Started NVDA with add-ons disabled, UIA events enabled and language interface set to English (I'm French).
  2. Pressed kb:windows+r.
  3. Typed "cmd" then kb:enter.
  4. Pressed kb:NVDA+Control+t until β€” Braille tethered to review β€”.
  5. Opened a SSH connection.
  6. Opened a file with nano (typed "nano foo.bar").
  7. Closed the file (pressed kb:control+x)
  8. Repeated steps 5 and 6 several times (about 15 times).

I kept this (full) log if you need more details.

codeofdusk commented 4 years ago

I can now reproduce the crash, however only with my physical Braille display connected (i.e. not with Braille viewer running).

Your log suggests that the console is crashing in moveEndPointByRange: line 789 of uia/__init__.py reads:

        self._rangeObj.MoveEndpointByRange(src,other._rangeObj,target)

Since this crash happens during a switch to/from the alt buffer, I suspect it is an uncaught fail fast in conhost, but see the following lines in the console source code (starting at around line 677 of types/UiaTextRangeBase.cpp:

IFACEMETHODIMP UiaTextRangeBase::MoveEndpointByRange(_In_ TextPatternRangeEndpoint endpoint,
                                                     _In_ ITextRangeProvider* pTargetRange,
                                                     _In_ TextPatternRangeEndpoint targetEndpoint) noexcept
try
{
    _pData->LockConsole();
    auto Unlock = wil::scope_exit([&]() noexcept {
        _pData->UnlockConsole();
    });

    const UiaTextRangeBase* range = static_cast<UiaTextRangeBase*>(pTargetRange);
    if (range == nullptr)
    {
        return E_INVALIDARG;
    }

    // TODO GH#5406: create a different UIA parent object for each TextBuffer
    //   This is a temporary solution to comparing two UTRs from different TextBuffers
    //   Ensure both endpoints fit in the current buffer.
    const auto bufferSize = _pData->GetTextBuffer().GetSize();
    const auto mine = GetEndpoint(endpoint);
    const auto other = range->GetEndpoint(targetEndpoint);
    if (!bufferSize.IsInBounds(mine, true) || !bufferSize.IsInBounds(other, true))
    {
        return E_FAIL;
    }

So that must not be it...

@carlos-zamora or @DHowett, Is there a way I can collect a stack trace to see where in the console code this is breaking? (since it only crashes with a display connected and not when using the Braille viewer, I'd be willing to let you remotely connect to my machine for data gathering/debugging purposes if necessary).

codeofdusk commented 4 years ago

Can you please try this build and let me know if the crash is fixed?

AAClause commented 4 years ago

I can still reproduce the issue. However it seems to happen after a longer period. I was able to open/exit nano ~40-50 times before crash (based on 4 tests).

Log (snippets) ``` INFO - __main__ (07:15:41.351) - MainThread (19612): Starting NVDA version alpha-21261,2d7d2988 [...] INFO - core.main (07:15:43.349) - MainThread (19612): Add-ons are disabled. Restart NVDA to enable them. [...] DEBUGWARNING - NVDAObjects.UIA.winConsoleUIA.WinConsoleUIA.detectPossibleSelectionChange (07:16:27.881) - MainThread (19612): Exception raised when comparing selections, probably due to a switch to/from the alt buffer. Traceback (most recent call last): File "NVDAObjects\UIA\winConsoleUIA.pyc", line 382, in detectPossibleSelectionChange File "editableText.pyc", line 348, in detectPossibleSelectionChange File "editableText.pyc", line 355, in _updateSelectionAnchor File "NVDAObjects\UIA\__init__.pyc", line 778, in compareEndPoints File "comtypesMonkeyPatches.pyc", line 26, in __call__ _ctypes.COMError: (-2147467259, 'Unspecified error', (None, None, None, 0, None)) [...] DEBUGWARNING - NVDAObjects.UIA.winConsoleUIA.WinConsoleUIA.detectPossibleSelectionChange (07:16:31.593) - MainThread (19612): Exception raised when comparing selections, probably due to a switch to/from the alt buffer. Traceback (most recent call last): File "NVDAObjects\UIA\winConsoleUIA.pyc", line 382, in detectPossibleSelectionChange File "editableText.pyc", line 348, in detectPossibleSelectionChange File "editableText.pyc", line 355, in _updateSelectionAnchor File "NVDAObjects\UIA\__init__.pyc", line 778, in compareEndPoints File "comtypesMonkeyPatches.pyc", line 26, in __call__ _ctypes.COMError: (-2147467259, 'Unspecified error', (None, None, None, 0, None)) [...] ERROR - core.CorePump.run (07:16:37.459) - MainThread (19612): errors in this core pump cycle Traceback (most recent call last): File "core.pyc", line 525, in run File "braille.pyc", line 2221, in pumpAll File "braille.pyc", line 1957, in handlePendingCaretUpdate File "braille.pyc", line 1963, in _doCursorMove File "braille.pyc", line 1014, in update File "NVDAObjects\UIA\__init__.pyc", line 789, in setEndPoint File "comtypesMonkeyPatches.pyc", line 26, in __call__ _ctypes.COMError: (-2147467259, 'Unspecified error', (None, None, None, 0, None)) [...] DEBUGWARNING - NVDAObjects.UIA.winConsoleUIA.WinConsoleUIA.detectPossibleSelectionChange (07:16:39.006) - MainThread (19612): Exception raised when comparing selections, probably due to a switch to/from the alt buffer. Traceback (most recent call last): File "NVDAObjects\UIA\winConsoleUIA.pyc", line 382, in detectPossibleSelectionChange File "editableText.pyc", line 348, in detectPossibleSelectionChange File "editableText.pyc", line 355, in _updateSelectionAnchor File "NVDAObjects\UIA\__init__.pyc", line 778, in compareEndPoints File "comtypesMonkeyPatches.pyc", line 26, in __call__ _ctypes.COMError: (-2147467259, 'Unspecified error', (None, None, None, 0, None)) [...] ERROR - eventHandler.executeEvent (07:16:43.793) - MainThread (19612): error executing event: caret on with extra args of {} Traceback (most recent call last): File "eventHandler.pyc", line 246, in executeEvent File "eventHandler.pyc", line 96, in __init__ File "eventHandler.pyc", line 105, in next File "NVDAObjects\behaviors.pyc", line 195, in event_caret File "NVDAObjects\__init__.pyc", line 1180, in event_caret File "review.pyc", line 174, in handleCaretMove File "documentBase.pyc", line 24, in makeTextInfo File "NVDAObjects\UIA\winConsoleUIA.pyc", line 37, in __init__ File "NVDAObjects\UIA\__init__.pyc", line 313, in __init__ File "NVDAObjects\UIA\__init__.pyc", line 767, in collapse File "comtypesMonkeyPatches.pyc", line 26, in __call__ _ctypes.COMError: (-2147467259, 'Unspecified error', (None, None, None, 0, None)) [...] DEBUGWARNING - NVDAObjects.UIA.winConsoleUIA.WinConsoleUIA.detectPossibleSelectionChange (07:16:55.456) - MainThread (19612): Exception raised when comparing selections, probably due to a switch to/from the alt buffer. Traceback (most recent call last): File "NVDAObjects\UIA\winConsoleUIA.pyc", line 382, in detectPossibleSelectionChange File "editableText.pyc", line 348, in detectPossibleSelectionChange File "editableText.pyc", line 355, in _updateSelectionAnchor File "NVDAObjects\UIA\__init__.pyc", line 778, in compareEndPoints File "comtypesMonkeyPatches.pyc", line 26, in __call__ _ctypes.COMError: (-2147467259, 'Unspecified error', (None, None, None, 0, None)) [...] DEBUGWARNING - NVDAObjects.UIA.winConsoleUIA.WinConsoleUIA.detectPossibleSelectionChange (07:16:57.557) - MainThread (19612): Exception raised when comparing selections, probably due to a switch to/from the alt buffer. Traceback (most recent call last): File "NVDAObjects\UIA\winConsoleUIA.pyc", line 382, in detectPossibleSelectionChange File "editableText.pyc", line 348, in detectPossibleSelectionChange File "editableText.pyc", line 355, in _updateSelectionAnchor File "NVDAObjects\UIA\__init__.pyc", line 778, in compareEndPoints File "comtypesMonkeyPatches.pyc", line 26, in __call__ _ctypes.COMError: (-2147467259, 'Unspecified error', (None, None, None, 0, None)) [...] DEBUGWARNING - NVDAObjects.UIA.winConsoleUIA.WinConsoleUIA.detectPossibleSelectionChange (07:16:59.148) - MainThread (19612): Exception raised when comparing selections, probably due to a switch to/from the alt buffer. Traceback (most recent call last): File "NVDAObjects\UIA\winConsoleUIA.pyc", line 382, in detectPossibleSelectionChange File "editableText.pyc", line 348, in detectPossibleSelectionChange File "editableText.pyc", line 355, in _updateSelectionAnchor File "NVDAObjects\UIA\__init__.pyc", line 778, in compareEndPoints File "comtypesMonkeyPatches.pyc", line 26, in __call__ _ctypes.COMError: (-2147467259, 'Unspecified error', (None, None, None, 0, None)) [...] DEBUGWARNING - NVDAObjects.UIA.winConsoleUIA.WinConsoleUIA.detectPossibleSelectionChange (07:16:59.689) - MainThread (19612): Exception raised when comparing selections, probably due to a switch to/from the alt buffer. Traceback (most recent call last): File "NVDAObjects\UIA\winConsoleUIA.pyc", line 382, in detectPossibleSelectionChange File "editableText.pyc", line 348, in detectPossibleSelectionChange File "editableText.pyc", line 355, in _updateSelectionAnchor File "NVDAObjects\UIA\__init__.pyc", line 778, in compareEndPoints File "comtypesMonkeyPatches.pyc", line 26, in __call__ _ctypes.COMError: (-2147467259, 'Unspecified error', (None, None, None, 0, None)) [...] ERROR - NVDAObjects.behaviors.LiveText._monitor (07:16:59.659) - Dynamic_WinConsoleUIAEditableTextWithAutoSelectDetectionUIA._monitorThread (12104): Error getting lines or calculating new text Traceback (most recent call last): File "NVDAObjects\behaviors.pyc", line 312, in _monitor File "NVDAObjects\UIA\winConsoleUIA.pyc", line 371, in _getTextLines File "NVDAObjects\behaviors.pyc", line 276, in _getTextLines File "textInfos\__init__.pyc", line 525, in getTextInChunks File "NVDAObjects\UIA\__init__.pyc", line 778, in compareEndPoints File "comtypesMonkeyPatches.pyc", line 26, in __call__ _ctypes.COMError: (-2147467259, 'Unspecified error', (None, None, None, 0, None)) [...] ERROR - core.CorePump.run (07:17:00.798) - MainThread (19612): errors in this core pump cycle Traceback (most recent call last): File "core.pyc", line 525, in run File "braille.pyc", line 2221, in pumpAll File "braille.pyc", line 1957, in handlePendingCaretUpdate File "braille.pyc", line 1963, in _doCursorMove File "braille.pyc", line 1041, in update File "documentBase.pyc", line 24, in makeTextInfo File "NVDAObjects\UIA\winConsoleUIA.pyc", line 39, in __init__ File "NVDAObjects\UIA\__init__.pyc", line 767, in collapse File "comtypesMonkeyPatches.pyc", line 26, in __call__ _ctypes.COMError: (-2147467259, 'Unspecified error', (None, None, None, 0, None)) [...] DEBUGWARNING - NVDAObjects.UIA.winConsoleUIA.WinConsoleUIA.detectPossibleSelectionChange (07:17:02.338) - MainThread (19612): Exception raised when comparing selections, probably due to a switch to/from the alt buffer. Traceback (most recent call last): File "NVDAObjects\UIA\winConsoleUIA.pyc", line 382, in detectPossibleSelectionChange File "editableText.pyc", line 348, in detectPossibleSelectionChange File "editableText.pyc", line 355, in _updateSelectionAnchor File "NVDAObjects\UIA\__init__.pyc", line 778, in compareEndPoints File "comtypesMonkeyPatches.pyc", line 26, in __call__ _ctypes.COMError: (-2147467259, 'Unspecified error', (None, None, None, 0, None)) [...] DEBUGWARNING - NVDAObjects.UIA.winConsoleUIA.WinConsoleUIA.detectPossibleSelectionChange (07:17:06.578) - MainThread (19612): Exception raised when comparing selections, probably due to a switch to/from the alt buffer. Traceback (most recent call last): File "NVDAObjects\UIA\winConsoleUIA.pyc", line 382, in detectPossibleSelectionChange File "editableText.pyc", line 348, in detectPossibleSelectionChange File "editableText.pyc", line 355, in _updateSelectionAnchor File "NVDAObjects\UIA\__init__.pyc", line 778, in compareEndPoints File "comtypesMonkeyPatches.pyc", line 26, in __call__ _ctypes.COMError: (-2147467259, 'Unspecified error', (None, None, None, 0, None)) [...] DEBUGWARNING - NVDAObjects.UIA.winConsoleUIA.WinConsoleUIA.detectPossibleSelectionChange (07:17:08.193) - MainThread (19612): Exception raised when comparing selections, probably due to a switch to/from the alt buffer. Traceback (most recent call last): File "NVDAObjects\UIA\winConsoleUIA.pyc", line 382, in detectPossibleSelectionChange File "editableText.pyc", line 348, in detectPossibleSelectionChange File "editableText.pyc", line 355, in _updateSelectionAnchor File "NVDAObjects\UIA\__init__.pyc", line 778, in compareEndPoints File "comtypesMonkeyPatches.pyc", line 26, in __call__ _ctypes.COMError: (-2147467259, 'Unspecified error', (None, None, None, 0, None)) [...] DEBUGWARNING - NVDAObjects.UIA.winConsoleUIA.WinConsoleUIA.detectPossibleSelectionChange (07:17:14.011) - MainThread (19612): Exception raised when comparing selections, probably due to a switch to/from the alt buffer. Traceback (most recent call last): File "NVDAObjects\UIA\winConsoleUIA.pyc", line 382, in detectPossibleSelectionChange File "editableText.pyc", line 348, in detectPossibleSelectionChange File "editableText.pyc", line 355, in _updateSelectionAnchor File "NVDAObjects\UIA\__init__.pyc", line 778, in compareEndPoints File "comtypesMonkeyPatches.pyc", line 26, in __call__ _ctypes.COMError: (-2147467259, 'Unspecified error', (None, None, None, 0, None)) [...] DEBUGWARNING - NVDAObjects.UIA.winConsoleUIA.WinConsoleUIA.detectPossibleSelectionChange (07:17:21.412) - MainThread (19612): Exception raised when comparing selections, probably due to a switch to/from the alt buffer. Traceback (most recent call last): File "NVDAObjects\UIA\winConsoleUIA.pyc", line 382, in detectPossibleSelectionChange File "editableText.pyc", line 348, in detectPossibleSelectionChange File "editableText.pyc", line 355, in _updateSelectionAnchor File "NVDAObjects\UIA\__init__.pyc", line 778, in compareEndPoints File "comtypesMonkeyPatches.pyc", line 26, in __call__ _ctypes.COMError: (-2147467259, 'Unspecified error', (None, None, None, 0, None)) [...] DEBUGWARNING - NVDAObjects.UIA.winConsoleUIA.WinConsoleUIA.detectPossibleSelectionChange (07:17:26.177) - MainThread (19612): Exception raised when comparing selections, probably due to a switch to/from the alt buffer. Traceback (most recent call last): File "NVDAObjects\UIA\winConsoleUIA.pyc", line 382, in detectPossibleSelectionChange File "editableText.pyc", line 348, in detectPossibleSelectionChange File "editableText.pyc", line 355, in _updateSelectionAnchor File "NVDAObjects\UIA\__init__.pyc", line 778, in compareEndPoints File "comtypesMonkeyPatches.pyc", line 26, in __call__ _ctypes.COMError: (-2147467259, 'Unspecified error', (None, None, None, 0, None)) [...] DEBUGWARNING - NVDAObjects.UIA.winConsoleUIA.WinConsoleUIA.detectPossibleSelectionChange (07:17:32.536) - MainThread (19612): Exception raised when comparing selections, probably due to a switch to/from the alt buffer. Traceback (most recent call last): File "NVDAObjects\UIA\winConsoleUIA.pyc", line 382, in detectPossibleSelectionChange File "editableText.pyc", line 348, in detectPossibleSelectionChange File "editableText.pyc", line 355, in _updateSelectionAnchor File "NVDAObjects\UIA\__init__.pyc", line 778, in compareEndPoints File "comtypesMonkeyPatches.pyc", line 26, in __call__ _ctypes.COMError: (-2147467259, 'Unspecified error', (None, None, None, 0, None)) [...] DEBUGWARNING - NVDAObjects.UIA.winConsoleUIA.WinConsoleUIA.detectPossibleSelectionChange (07:17:38.374) - MainThread (19612): Exception raised when comparing selections, probably due to a switch to/from the alt buffer. Traceback (most recent call last): File "NVDAObjects\UIA\winConsoleUIA.pyc", line 382, in detectPossibleSelectionChange File "editableText.pyc", line 348, in detectPossibleSelectionChange File "editableText.pyc", line 355, in _updateSelectionAnchor File "NVDAObjects\UIA\__init__.pyc", line 778, in compareEndPoints File "comtypesMonkeyPatches.pyc", line 26, in __call__ _ctypes.COMError: (-2147467259, 'Unspecified error', (None, None, None, 0, None)) [...] DEBUGWARNING - NVDAObjects.UIA.winConsoleUIA.WinConsoleUIA.detectPossibleSelectionChange (07:17:39.957) - MainThread (19612): Exception raised when comparing selections, probably due to a switch to/from the alt buffer. Traceback (most recent call last): File "NVDAObjects\UIA\winConsoleUIA.pyc", line 382, in detectPossibleSelectionChange File "editableText.pyc", line 348, in detectPossibleSelectionChange File "editableText.pyc", line 355, in _updateSelectionAnchor File "NVDAObjects\UIA\__init__.pyc", line 778, in compareEndPoints File "comtypesMonkeyPatches.pyc", line 26, in __call__ _ctypes.COMError: (-2147467259, 'Unspecified error', (None, None, None, 0, None)) [...] DEBUGWARNING - watchdog._watcher (07:17:43.117) - watchdog (21264): Trying to recover from freeze. Listing stacks for Python threads: Python stack for thread 14368 (Dummy-2): File "comtypes\_comobject.pyc", line 147, in call_without_this File "_UIAHandler.pyc", line 456, in IUIAutomationEventHandler_HandleAutomationEvent File "_UIAHandler.pyc", line 737, in getNearestWindowHandle File "comtypesMonkeyPatches.pyc", line 26, in __call__ Python stack for thread 12104 (Dynamic_WinConsoleUIAEditableTextWithAutoSelectDetectionUIA._monitorThread): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "NVDAObjects\behaviors.pyc", line 300, in _monitor File "threading.pyc", line 552, in wait File "threading.pyc", line 296, in wait Python stack for thread 21264 (watchdog): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "watchdog.pyc", line 127, in _watcher File "watchdog.pyc", line 63, in getFormattedStacksForAllThreads Python stack for thread 6088 (winInputHook): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "winInputHook.pyc", line 79, in hookThreadFunc Python stack for thread 5400 (_UIAHandler.UIAHandler.MTAThread): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "_UIAHandler.pyc", line 310, in MTAThreadFunc File "queue.pyc", line 170, in get File "threading.pyc", line 296, in wait Python stack for thread 10272 (braille._BgThread): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "braille.pyc", line 2187, in func Python stack for thread 19612 (MainThread): File "nvda.pyw", line 236, in File "core.pyc", line 553, in main File "wx\core.pyc", line 2134, in MainLoop File "gui\__init__.pyc", line 1062, in Notify File "core.pyc", line 525, in run File "braille.pyc", line 2221, in pumpAll File "braille.pyc", line 1957, in handlePendingCaretUpdate File "braille.pyc", line 1963, in _doCursorMove File "braille.pyc", line 1016, in update File "braille.pyc", line 854, in _addTextWithFields File "NVDAObjects\UIA\__init__.pyc", line 718, in getTextWithFields File "NVDAObjects\UIA\__init__.pyc", line 706, in _getTextWithFieldsForUIARange File "NVDAObjects\UIA\__init__.pyc", line 491, in _getTextWithFields_text File "NVDAObjects\UIA\__init__.pyc", line 457, in _getTextFromUIARange File "comtypesMonkeyPatches.pyc", line 26, in __call__ DEBUGWARNING - NVDAObjects.__call__ (07:17:45.383) - Dummy-2 (14368): Invalid NVDAObject: no windowHandle Traceback (most recent call last): File "NVDAObjects\__init__.pyc", line 82, in __call__ File "NVDAObjects\UIA\__init__.pyc", line 1060, in __init__ NVDAObjects.InvalidNVDAObject: no windowHandle DEBUG - _UIAHandler.UIAHandler.IUIAutomationEventHandler_HandleAutomationEvent (07:17:45.385) - Dummy-2 (14368): HandleAutomationEvent: Ignoring event textChange because no object or ignored by object itself DEBUGWARNING - NVDAObjects.__call__ (07:17:45.388) - Dummy-2 (14368): Invalid NVDAObject: no windowHandle Traceback (most recent call last): File "NVDAObjects\__init__.pyc", line 82, in __call__ File "NVDAObjects\UIA\__init__.pyc", line 1060, in __init__ NVDAObjects.InvalidNVDAObject: no windowHandle DEBUG - _UIAHandler.UIAHandler.IUIAutomationEventHandler_HandleAutomationEvent (07:17:45.388) - Dummy-2 (14368): HandleAutomationEvent: Ignoring event textChange because no object or ignored by object itself DEBUGWARNING - NVDAObjects.__call__ (07:17:45.391) - Dummy-2 (14368): Invalid NVDAObject: no windowHandle Traceback (most recent call last): File "NVDAObjects\__init__.pyc", line 82, in __call__ File "NVDAObjects\UIA\__init__.pyc", line 1060, in __init__ NVDAObjects.InvalidNVDAObject: no windowHandle DEBUG - _UIAHandler.UIAHandler.IUIAutomationEventHandler_HandleAutomationEvent (07:17:45.391) - Dummy-2 (14368): HandleAutomationEvent: Ignoring event textChange because no object or ignored by object itself ERROR - core.CorePump.run (07:17:45.376) - MainThread (19612): errors in this core pump cycle Traceback (most recent call last): File "core.pyc", line 525, in run File "braille.pyc", line 2221, in pumpAll File "braille.pyc", line 1957, in handlePendingCaretUpdate File "braille.pyc", line 1963, in _doCursorMove File "braille.pyc", line 1016, in update File "braille.pyc", line 854, in _addTextWithFields File "NVDAObjects\UIA\__init__.pyc", line 718, in getTextWithFields File "NVDAObjects\UIA\__init__.pyc", line 706, in _getTextWithFieldsForUIARange File "NVDAObjects\UIA\__init__.pyc", line 491, in _getTextWithFields_text File "NVDAObjects\UIA\__init__.pyc", line 457, in _getTextFromUIARange File "comtypesMonkeyPatches.pyc", line 26, in __call__ _ctypes.COMError: (-2147418113, 'Catastrophic Failure', (None, None, None, 0, None)) DEBUGWARNING - NVDAObjects.IAccessible.IAccessible._get_IAccessibleRole (07:17:45.574) - MainThread (19612): accRole failed: (-2147024809, 'The parameter is incorrect.', (None, None, None, 0, None)) DEBUG - appModuleHandler.cleanup (07:17:45.690) - MainThread (19612): application openconsole closed ```
codeofdusk commented 4 years ago

I cannot reproduce the issue with the linked build, even when running/exiting Nano over 100 times.

codeofdusk commented 4 years ago

Just for consistency in setup, could you please run the following in the Python console (nvda+control+z) and put the output here?

{k: v for k,v in config.conf["documentFormatting"].items()}
AAClause commented 4 years ago
>>> {k: v for k,v in config.conf["documentFormatting"].items()}
{'reportTableCellCoords': True, 'reportClickable': True, 'reportTableHeaders': True, 'reportTables': True, 'autoLanguageSwitching': 'False', 'reportArticles': True, 'reportFontAttributes': True, 'reportSuperscriptsAndSubscripts': True, 'reportColor': False, 'reportEmphasis': True, 'reportStyle': False, 'reportLinks': True, 'reportBorderStyle': False, 'reportBorderColor': False, 'reportAlignment': True, 'reportLineIndentationWithTones': False, 'reportParagraphIndentation': True, 'reportLineSpacing': True, 'reportLineNumber': False, 'detectFormatAfterCursor': False, 'reportLineIndentation': False, 'reportFontName': False, 'reportFontSize': False, 'reportRevisions': True, 'reportHighlight': True, 'reportSpellingErrors': True, 'reportPage': True, 'includeLayoutTables': False, 'reportGraphics': True, 'reportComments': True, 'reportLists': True, 'reportHeadings': True, 'reportBlockQuotes': True, 'reportGroupings': True, 'reportLandmarks': True, 'reportFrames': True}
AAClause commented 4 years ago

I've just created a portable version of NVDA (without my configuration) and I'm unable to reproduce the issue (running/exiting Nano over 100 times too).

codeofdusk commented 4 years ago

I've copied your exact config, using:

console fragment
```python d = {'reportTableCellCoords': True, 'reportClickable': True, 'reportTableHeaders': True, 'reportTables': True, 'autoLanguageSwitching': 'False', 'reportArticles': True, 'reportFontAttributes': True, 'reportSuperscriptsAndSubscripts': True, 'reportColor': False, 'reportEmphasis': True, 'reportStyle': False, 'reportLinks': True, 'reportBorderStyle': False, 'reportBorderColor': False, 'reportAlignment': True, 'reportLineIndentationWithTones': False, 'reportParagraphIndentation': True, 'reportLineSpacing': True, 'reportLineNumber': False, 'detectFormatAfterCursor': False, 'reportLineIndentation': False, 'reportFontName': False, 'reportFontSize': False, 'reportRevisions': True, 'reportHighlight': True, 'reportSpellingErrors': True, 'reportPage': True, 'includeLayoutTables': False, 'reportGraphics': True, 'reportComments': True, 'reportLists': True, 'reportHeadings': True, 'reportBlockQuotes': True, 'reportGroupings': True, 'reportLandmarks': True, 'reportFrames': True} for k, v in d.items(): config.conf["documentFormatting"][k] = v ```

With a Braille display connected, in that build of UIA console, I still can't reproduce the crash running over 100 times. So it must not be formatting settings.

Could you please paste the contents of your nvda.ini file in %appdata%\nvda?

AAClause commented 4 years ago

Sorry, I forgot to enable "Use UI Automation to access the Windows Console when available" on my fresh copy of NVDA. I can reproduce the issue with no personal customization.

Also during a test, I received a serious freeze (about 30 seconds)...

Log extract ``` DEBUGWARNING - watchdog._watcher (09:42:36.473) - watchdog (18896): Trying to recover from freeze. Listing stacks for Python threads: Python stack for thread 19432 (Dummy-1): File "comtypes\_comobject.pyc", line 147, in call_without_this File "_UIAHandler.pyc", line 456, in IUIAutomationEventHandler_HandleAutomationEvent File "_UIAHandler.pyc", line 737, in getNearestWindowHandle File "comtypesMonkeyPatches.pyc", line 26, in __call__ Python stack for thread 9664 (Dynamic_WinConsoleUIAEditableTextWithAutoSelectDetectionUIA._monitorThread): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "NVDAObjects\behaviors.pyc", line 300, in _monitor File "threading.pyc", line 552, in wait File "threading.pyc", line 296, in wait Python stack for thread 22504 (synthDrivers._espeak.BgThread): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "synthDrivers\_espeak.pyc", line 191, in run File "queue.pyc", line 170, in get File "threading.pyc", line 296, in wait Python stack for thread 460 (watchdog.CancellableCallThread.execute(<_FuncPtr object at 0x09CF7B70>)): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "watchdog.pyc", line 332, in run File "threading.pyc", line 552, in wait File "threading.pyc", line 296, in wait Python stack for thread 18896 (watchdog): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "watchdog.pyc", line 127, in _watcher File "watchdog.pyc", line 63, in getFormattedStacksForAllThreads Python stack for thread 16376 (winInputHook): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "winInputHook.pyc", line 79, in hookThreadFunc Python stack for thread 22336 (_UIAHandler.UIAHandler.MTAThread): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "_UIAHandler.pyc", line 310, in MTAThreadFunc File "queue.pyc", line 170, in get File "threading.pyc", line 296, in wait Python stack for thread 19496 (braille._BgThread): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "braille.pyc", line 2187, in func Python stack for thread 1236 (MainThread): File "nvda.pyw", line 236, in File "core.pyc", line 553, in main File "wx\core.pyc", line 2134, in MainLoop File "gui\__init__.pyc", line 1062, in Notify File "core.pyc", line 523, in run File "queueHandler.pyc", line 88, in pumpAll File "queueHandler.pyc", line 55, in flushQueue File "eventHandler.pyc", line 65, in _queueEventCallback File "eventHandler.pyc", line 246, in executeEvent File "eventHandler.pyc", line 96, in __init__ File "eventHandler.pyc", line 105, in next File "NVDAObjects\behaviors.pyc", line 195, in event_caret File "NVDAObjects\__init__.pyc", line 1180, in event_caret File "review.pyc", line 177, in handleCaretMove File "api.pyc", line 215, in setReviewPosition File "braille.pyc", line 2036, in handleReviewMove File "braille.pyc", line 1963, in _doCursorMove File "braille.pyc", line 1016, in update File "braille.pyc", line 854, in _addTextWithFields File "NVDAObjects\UIA\__init__.pyc", line 718, in getTextWithFields File "NVDAObjects\UIA\__init__.pyc", line 706, in _getTextWithFieldsForUIARange File "NVDAObjects\UIA\__init__.pyc", line 491, in _getTextWithFields_text File "NVDAObjects\UIA\__init__.pyc", line 457, in _getTextFromUIARange File "comtypesMonkeyPatches.pyc", line 26, in __call__ ERROR - watchdog._watcher (09:42:51.486) - watchdog (18896): Core frozen in stack! INFO - watchdog._watcher (09:42:51.533) - watchdog (18896): Listing stacks for Python threads: Python stack for thread 15768 (nvwave.playWaveFile(error.wav)): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "nvwave.pyc", line 426, in idle File "nvwave.pyc", line 436, in _idleUnbuffered File "nvwave.pyc", line 386, in sync File "winKernel.pyc", line 228, in waitForSingleObject Python stack for thread 19432 (Dummy-1): File "comtypes\_comobject.pyc", line 147, in call_without_this File "_UIAHandler.pyc", line 456, in IUIAutomationEventHandler_HandleAutomationEvent File "_UIAHandler.pyc", line 737, in getNearestWindowHandle File "comtypesMonkeyPatches.pyc", line 26, in __call__ Python stack for thread 9664 (Dynamic_WinConsoleUIAEditableTextWithAutoSelectDetectionUIA._monitorThread): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "NVDAObjects\behaviors.pyc", line 300, in _monitor File "threading.pyc", line 552, in wait File "threading.pyc", line 296, in wait Python stack for thread 22504 (synthDrivers._espeak.BgThread): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "synthDrivers\_espeak.pyc", line 191, in run File "queue.pyc", line 170, in get File "threading.pyc", line 296, in wait Python stack for thread 460 (watchdog.CancellableCallThread.execute(<_FuncPtr object at 0x09CF7B70>)): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "watchdog.pyc", line 332, in run File "threading.pyc", line 552, in wait File "threading.pyc", line 296, in wait Python stack for thread 18896 (watchdog): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "watchdog.pyc", line 142, in _watcher File "watchdog.pyc", line 63, in getFormattedStacksForAllThreads Python stack for thread 16376 (winInputHook): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "winInputHook.pyc", line 79, in hookThreadFunc Python stack for thread 22336 (_UIAHandler.UIAHandler.MTAThread): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "_UIAHandler.pyc", line 310, in MTAThreadFunc File "queue.pyc", line 170, in get File "threading.pyc", line 296, in wait Python stack for thread 19496 (braille._BgThread): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "braille.pyc", line 2187, in func Python stack for thread 1236 (MainThread): File "nvda.pyw", line 236, in File "core.pyc", line 553, in main File "wx\core.pyc", line 2134, in MainLoop File "gui\__init__.pyc", line 1062, in Notify File "core.pyc", line 523, in run File "queueHandler.pyc", line 88, in pumpAll File "queueHandler.pyc", line 55, in flushQueue File "eventHandler.pyc", line 65, in _queueEventCallback File "eventHandler.pyc", line 246, in executeEvent File "eventHandler.pyc", line 96, in __init__ File "eventHandler.pyc", line 105, in next File "NVDAObjects\behaviors.pyc", line 195, in event_caret File "NVDAObjects\__init__.pyc", line 1180, in event_caret File "review.pyc", line 177, in handleCaretMove File "api.pyc", line 215, in setReviewPosition File "braille.pyc", line 2036, in handleReviewMove File "braille.pyc", line 1963, in _doCursorMove File "braille.pyc", line 1016, in update File "braille.pyc", line 854, in _addTextWithFields File "NVDAObjects\UIA\__init__.pyc", line 718, in getTextWithFields File "NVDAObjects\UIA\__init__.pyc", line 706, in _getTextWithFieldsForUIARange File "NVDAObjects\UIA\__init__.pyc", line 491, in _getTextWithFields_text File "NVDAObjects\UIA\__init__.pyc", line 457, in _getTextFromUIARange File "comtypesMonkeyPatches.pyc", line 26, in __call__ DEBUGWARNING - NVDAObjects.__call__ (09:42:56.111) - Dummy-1 (19432): Invalid NVDAObject: no windowHandle Traceback (most recent call last): File "NVDAObjects\__init__.pyc", line 82, in __call__ File "NVDAObjects\UIA\__init__.pyc", line 1060, in __init__ NVDAObjects.InvalidNVDAObject: no windowHandle DEBUGWARNING - NVDAObjects.__call__ (09:42:56.116) - Dummy-1 (19432): Invalid NVDAObject: no windowHandle Traceback (most recent call last): File "NVDAObjects\__init__.pyc", line 82, in __call__ File "NVDAObjects\UIA\__init__.pyc", line 1060, in __init__ NVDAObjects.InvalidNVDAObject: no windowHandle DEBUGWARNING - NVDAObjects.__call__ (09:42:56.119) - Dummy-1 (19432): Invalid NVDAObject: no windowHandle Traceback (most recent call last): File "NVDAObjects\__init__.pyc", line 82, in __call__ File "NVDAObjects\UIA\__init__.pyc", line 1060, in __init__ NVDAObjects.InvalidNVDAObject: no windowHandle ERROR - eventHandler.executeEvent (09:42:56.103) - MainThread (1236): error executing event: caret on with extra args of {} Traceback (most recent call last): File "eventHandler.pyc", line 246, in executeEvent File "eventHandler.pyc", line 96, in __init__ File "eventHandler.pyc", line 105, in next File "NVDAObjects\behaviors.pyc", line 195, in event_caret File "NVDAObjects\__init__.pyc", line 1180, in event_caret File "review.pyc", line 177, in handleCaretMove File "api.pyc", line 215, in setReviewPosition File "braille.pyc", line 2036, in handleReviewMove File "braille.pyc", line 1963, in _doCursorMove File "braille.pyc", line 1016, in update File "braille.pyc", line 854, in _addTextWithFields File "NVDAObjects\UIA\__init__.pyc", line 718, in getTextWithFields File "NVDAObjects\UIA\__init__.pyc", line 706, in _getTextWithFieldsForUIARange File "NVDAObjects\UIA\__init__.pyc", line 491, in _getTextWithFields_text File "NVDAObjects\UIA\__init__.pyc", line 457, in _getTextFromUIARange File "comtypesMonkeyPatches.pyc", line 26, in __call__ _ctypes.COMError: (-2146233083, None, (None, None, None, 0, None)) DEBUGWARNING - watchdog._watcher (09:42:56.683) - watchdog (18896): Trying to recover from freeze. Listing stacks for Python threads: Python stack for thread 9664 (Dynamic_WinConsoleUIAEditableTextWithAutoSelectDetectionUIA._monitorThread): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "NVDAObjects\behaviors.pyc", line 300, in _monitor File "threading.pyc", line 552, in wait File "threading.pyc", line 296, in wait Python stack for thread 22504 (synthDrivers._espeak.BgThread): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "synthDrivers\_espeak.pyc", line 191, in run File "queue.pyc", line 170, in get File "threading.pyc", line 296, in wait Python stack for thread 460 (watchdog.CancellableCallThread.execute(<_FuncPtr object at 0x09CF7B70>)): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "watchdog.pyc", line 332, in run File "threading.pyc", line 552, in wait File "threading.pyc", line 296, in wait Python stack for thread 18896 (watchdog): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "watchdog.pyc", line 127, in _watcher File "watchdog.pyc", line 63, in getFormattedStacksForAllThreads Python stack for thread 16376 (winInputHook): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "winInputHook.pyc", line 79, in hookThreadFunc Python stack for thread 22336 (_UIAHandler.UIAHandler.MTAThread): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "_UIAHandler.pyc", line 310, in MTAThreadFunc File "queue.pyc", line 170, in get File "threading.pyc", line 296, in wait Python stack for thread 19496 (braille._BgThread): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "braille.pyc", line 2187, in func Python stack for thread 1236 (MainThread): File "nvda.pyw", line 236, in File "core.pyc", line 553, in main File "wx\core.pyc", line 2134, in MainLoop File "gui\__init__.pyc", line 1062, in Notify File "core.pyc", line 522, in run File "IAccessibleHandler\__init__.pyc", line 1099, in pumpAll File "IAccessibleHandler\__init__.pyc", line 691, in processGenericWinEvent File "IAccessibleHandler\__init__.pyc", line 636, in winEventToNVDAEvent File "NVDAObjects\IAccessible\__init__.pyc", line 42, in getNVDAObjectFromEvent File "IAccessibleHandler\__init__.pyc", line 412, in accessibleObjectFromEvent File "oleacc.pyc", line 265, in AccessibleObjectFromEvent ERROR - watchdog._watcher (09:43:11.728) - watchdog (18896): Core frozen in stack! INFO - watchdog._watcher (09:43:11.776) - watchdog (18896): Listing stacks for Python threads: Python stack for thread 19028 (nvwave.playWaveFile(error.wav)): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "nvwave.pyc", line 426, in idle File "nvwave.pyc", line 436, in _idleUnbuffered File "nvwave.pyc", line 386, in sync File "winKernel.pyc", line 228, in waitForSingleObject Python stack for thread 9664 (Dynamic_WinConsoleUIAEditableTextWithAutoSelectDetectionUIA._monitorThread): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "NVDAObjects\behaviors.pyc", line 300, in _monitor File "threading.pyc", line 552, in wait File "threading.pyc", line 296, in wait Python stack for thread 22504 (synthDrivers._espeak.BgThread): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "synthDrivers\_espeak.pyc", line 191, in run File "queue.pyc", line 170, in get File "threading.pyc", line 296, in wait Python stack for thread 460 (watchdog.CancellableCallThread.execute(<_FuncPtr object at 0x09CF7B70>)): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "watchdog.pyc", line 332, in run File "threading.pyc", line 552, in wait File "threading.pyc", line 296, in wait Python stack for thread 18896 (watchdog): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "watchdog.pyc", line 142, in _watcher File "watchdog.pyc", line 63, in getFormattedStacksForAllThreads Python stack for thread 16376 (winInputHook): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "winInputHook.pyc", line 79, in hookThreadFunc Python stack for thread 22336 (_UIAHandler.UIAHandler.MTAThread): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "_UIAHandler.pyc", line 310, in MTAThreadFunc File "queue.pyc", line 170, in get File "threading.pyc", line 296, in wait Python stack for thread 19496 (braille._BgThread): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "braille.pyc", line 2187, in func Python stack for thread 1236 (MainThread): File "nvda.pyw", line 236, in File "core.pyc", line 553, in main File "wx\core.pyc", line 2134, in MainLoop File "gui\__init__.pyc", line 1062, in Notify File "core.pyc", line 522, in run File "IAccessibleHandler\__init__.pyc", line 1099, in pumpAll File "IAccessibleHandler\__init__.pyc", line 691, in processGenericWinEvent File "IAccessibleHandler\__init__.pyc", line 636, in winEventToNVDAEvent File "NVDAObjects\IAccessible\__init__.pyc", line 42, in getNVDAObjectFromEvent File "IAccessibleHandler\__init__.pyc", line 412, in accessibleObjectFromEvent File "oleacc.pyc", line 265, in AccessibleObjectFromEvent ERROR - watchdog._watcher (09:43:26.746) - watchdog (18896): Core frozen in stack! INFO - watchdog._watcher (09:43:26.802) - watchdog (18896): Listing stacks for Python threads: Python stack for thread 10672 (nvwave.playWaveFile(error.wav)): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "nvwave.pyc", line 426, in idle File "nvwave.pyc", line 436, in _idleUnbuffered File "nvwave.pyc", line 386, in sync File "winKernel.pyc", line 228, in waitForSingleObject Python stack for thread 9664 (Dynamic_WinConsoleUIAEditableTextWithAutoSelectDetectionUIA._monitorThread): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "NVDAObjects\behaviors.pyc", line 300, in _monitor File "threading.pyc", line 552, in wait File "threading.pyc", line 296, in wait Python stack for thread 22504 (synthDrivers._espeak.BgThread): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "synthDrivers\_espeak.pyc", line 191, in run File "queue.pyc", line 170, in get File "threading.pyc", line 296, in wait Python stack for thread 460 (watchdog.CancellableCallThread.execute(<_FuncPtr object at 0x09CF7B70>)): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "watchdog.pyc", line 332, in run File "threading.pyc", line 552, in wait File "threading.pyc", line 296, in wait Python stack for thread 18896 (watchdog): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "watchdog.pyc", line 142, in _watcher File "watchdog.pyc", line 63, in getFormattedStacksForAllThreads Python stack for thread 16376 (winInputHook): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "winInputHook.pyc", line 79, in hookThreadFunc Python stack for thread 22336 (_UIAHandler.UIAHandler.MTAThread): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "_UIAHandler.pyc", line 310, in MTAThreadFunc File "queue.pyc", line 170, in get File "threading.pyc", line 296, in wait Python stack for thread 19496 (braille._BgThread): File "threading.pyc", line 890, in _bootstrap File "threading.pyc", line 926, in _bootstrap_inner File "threading.pyc", line 870, in run File "braille.pyc", line 2187, in func Python stack for thread 1236 (MainThread): File "nvda.pyw", line 236, in File "core.pyc", line 553, in main File "wx\core.pyc", line 2134, in MainLoop File "gui\__init__.pyc", line 1062, in Notify File "core.pyc", line 522, in run File "IAccessibleHandler\__init__.pyc", line 1099, in pumpAll File "IAccessibleHandler\__init__.pyc", line 691, in processGenericWinEvent File "IAccessibleHandler\__init__.pyc", line 636, in winEventToNVDAEvent File "NVDAObjects\IAccessible\__init__.pyc", line 42, in getNVDAObjectFromEvent File "IAccessibleHandler\__init__.pyc", line 412, in accessibleObjectFromEvent File "oleacc.pyc", line 265, in AccessibleObjectFromEvent DEBUG - appModuleHandler.cleanup (09:43:28.802) - MainThread (1236): application openconsole closed ```

For reference, here's my minimal configuration (on this copy):

schemaVersion = 4
[update]
    autoCheck = True
    startupNotification = True
    allowUsageStats = False
    askedAllowUsageStats = True
[general]
    language = en
    saveConfigurationOnExit = True
    askToExit = True
    playStartAndExitSounds = False
    loggingLevel = DEBUG
    showWelcomeDialogAtStartup = False
[development]
    enableScratchpadDir = False
[upgrade]
[speech]
    synth = espeak
    outputDevice = Mappeur de sons Microsoft
    [[oneCore]]
        voice = HKEY_LOCAL_MACHINE\SOFTWARE\Microsoft\Speech_OneCore\Voices\Tokens\MSTTS_V110_frFR_HortenseM
        volume = 100
    [[espeak]]
        voice = fr
        variant = max
        rate = 70
        pitch = 40
        inflection = 75
        volume = 100
[braille]
    [[noBraille]]
    [[baum]]
[keyboard]
    keyboardLayout = laptop
    useCapsLockAsNVDAModifierKey = True
    speakTypedCharacters = False
[vision]
    [[NVDAHighlighter]]
        highlightFocus = False
        highlightNavigator = False
        highlightBrowseMode = False
    [[screenCurtain]]
[UIA]
    useInMSWordWhenAvailable = True
    winConsoleImplementation = UIA
[debugLog]
    UIA = True
codeofdusk commented 4 years ago

OK, please try the following:

  1. Download and extract this build.
  2. Open (and add to registry) EnableCrashDumps.reg (feel free to view it in notepad, it's mostly human-readable).
  3. Run OpenConsole.exe and reproduce the crash from that console.
    • this is a debug build, so UIA (particularly word navigation) may be very slow. However, the debug symbols available will allow me or Microsoft to find the problem more easily.
  4. Navigate (in Windows Explorer) to %localappdata%\CrashDumps and send the most recent .dmp file for OpenConsole.
    • The file should attach to GitHub, but if it's too big DM me.

Also going to CC @miniksa on this issue.

AAClause commented 4 years ago

I'm not familiar with dmp files and I don't know if can contain sensitive data. So I prefer to avoid publicly sharing this. Sent to @codeofdusk in DM.

AAClause commented 3 years ago

Windows 10 Insider 21301.1000, NVDA alpha-21685,90dd4e9a: I'm no longer able to reproduce the crash. Closing.