MAPI_E_INVALID_ENTRYID in search.log
-
Hello,
i’ve just upgraded from KC 8.3.1-42 to 8.4.2.0-10, did some research on logs for errors and found this one in my search.log:
2017-11-04 18:34:03,665 - index3 - ERROR - Traceback (most recent call last): File "/usr/lib/python2.7/site-packages/kopano/log.py", line 87, in log_exc try: yield File "/usr/lib/python2.7/site-packages/kopano_search/__init__.py", line 199, in main folder = kopano.Folder(store, folderid) File "/usr/lib/python2.7/site-packages/kopano/folder.py", line 79, in __init__ self.mapiobj = store.mapiobj.OpenEntry(entryid, IID_IMAPIFolder, MAPI_MODIFY) File "/usr/lib/python2.7/site-packages/MAPICore.py", line 441, in OpenEntry def OpenEntry(self, *args): return _MAPICore.IMsgStore_OpenEntry(self, *args) MAPIErrorInvalidEntryid: MAPI error 80040107 (MAPI_E_INVALID_ENTRYID) 2017-11-04 18:34:03,665 - search - INFO - queue processed in 0.05 seconds (0 changes, ~0.00/sec) 2017-11-04 18:34:03,666 - search - INFO - saved server sync state = 4D0501005A9C2103 2017-11-04 18:35:03,759 - index0 - ERROR - Traceback (most recent call last): File "/usr/lib/python2.7/site-packages/kopano/log.py", line 87, in log_exc try: yield File "/usr/lib/python2.7/site-packages/kopano_search/__init__.py", line 199, in main folder = kopano.Folder(store, folderid) File "/usr/lib/python2.7/site-packages/kopano/folder.py", line 79, in __init__ self.mapiobj = store.mapiobj.OpenEntry(entryid, IID_IMAPIFolder, MAPI_MODIFY) File "/usr/lib/python2.7/site-packages/MAPICore.py", line 441, in OpenEntry def OpenEntry(self, *args): return _MAPICore.IMsgStore_OpenEntry(self, *args) MAPIErrorInvalidEntryid: MAPI error 80040107 (MAPI_E_INVALID_ENTRYID) 2017-11-04 18:35:03,793 - index2 - ERROR - Traceback (most recent call last): File "/usr/lib/python2.7/site-packages/kopano/log.py", line 87, in log_exc try: yield File "/usr/lib/python2.7/site-packages/kopano_search/__init__.py", line 199, in main folder = kopano.Folder(store, folderid) File "/usr/lib/python2.7/site-packages/kopano/folder.py", line 79, in __init__ self.mapiobj = store.mapiobj.OpenEntry(entryid, IID_IMAPIFolder, MAPI_MODIFY) File "/usr/lib/python2.7/site-packages/MAPICore.py", line 441, in OpenEntry def OpenEntry(self, *args): return _MAPICore.IMsgStore_OpenEntry(self, *args) MAPIErrorInvalidEntryid: MAPI error 80040107 (MAPI_E_INVALID_ENTRYID) 2017-11-04 18:35:03,793 - search - INFO - queue processed in 0.05 seconds (0 changes, ~0.00/sec) 2017-11-04 18:35:03,794 - search - INFO - saved server sync state = 4D0501005E9C2103 2017-11-04 18:36:03,887 - index1 - ERROR - Traceback (most recent call last): File "/usr/lib/python2.7/site-packages/kopano/log.py", line 87, in log_exc try: yield File "/usr/lib/python2.7/site-packages/kopano_search/__init__.py", line 199, in main folder = kopano.Folder(store, folderid) File "/usr/lib/python2.7/site-packages/kopano/folder.py", line 79, in __init__ self.mapiobj = store.mapiobj.OpenEntry(entryid, IID_IMAPIFolder, MAPI_MODIFY) File "/usr/lib/python2.7/site-packages/MAPICore.py", line 441, in OpenEntry def OpenEntry(self, *args): return _MAPICore.IMsgStore_OpenEntry(self, *args) MAPIErrorInvalidEntryid: MAPI error 80040107 (MAPI_E_INVALID_ENTRYID)
i cant find any problems if i search… results are dispalyed, its working fast (0,05 sec for 427 results), but every minute it displays this error
does someone know this issue?Coffee_is_life
-
I noticed something similar here: kc entryid-corruption.
++umgfoin. -
Hello again,
I’ve just searched for the start of my MAPI_E_INVALID_ENTRYID erro and found it:
2017-11-04 17:24:04,238 - search - INFO - queue processed in 0.07 seconds (4 changes, ~56.63/sec) 2017-11-04 17:24:04,239 - search - INFO - saved server sync state = 4D05010021902103 2017-11-04 17:24:19,276 - search - ERROR - Traceback (most recent call last): File "/usr/lib/python2.7/site-packages/kopano/log.py", line 87, in log_exc try: yield File "/usr/lib/python2.7/site-packages/kopano_search/__init__.py", line 351, in incremental_sync new_state = self.server.sync(importer, self.state, log=self.log) File "/usr/lib/python2.7/site-packages/kopano/server.py", line 566, in sync return _utils.sync(self, self.mapistore, importer, state, log or self.log, max_changes, window=window, begin=begin, end=end, stats=stats) File "/usr/lib/python2.7/site-packages/kopano/utils.py", line 287, in sync exporter.Config(stream, SYNC_NORMAL | SYNC_ASSOCIATED | SYNC_UNICODE, importer, restriction, None, None, 0) File "/usr/lib/python2.7/site-packages/MAPICore.py", line 1341, in Config def Config(self, *args): return _MAPICore.IExchangeExportChanges_Config(self, *args) MAPIErrorNetworkError: MAPI error 80040115 (MAPI_E_NETWORK_ERROR) 2017-11-04 17:24:24,278 - search - ERROR - Traceback (most recent call last): File "/usr/lib/python2.7/site-packages/kopano/log.py", line 87, in log_exc try: yield File "/usr/lib/python2.7/site-packages/kopano_search/__init__.py", line 351, in incremental_sync new_state = self.server.sync(importer, self.state, log=self.log) File "/usr/lib/python2.7/site-packages/kopano/server.py", line 566, in sync return _utils.sync(self, self.mapistore, importer, state, log or self.log, max_changes, window=window, begin=begin, end=end, stats=stats) File "/usr/lib/python2.7/site-packages/kopano/utils.py", line 287, in sync exporter.Config(stream, SYNC_NORMAL | SYNC_ASSOCIATED | SYNC_UNICODE, importer, restriction, None, None, 0) File "/usr/lib/python2.7/site-packages/MAPICore.py", line 1341, in Config def Config(self, *args): return _MAPICore.IExchangeExportChanges_Config(self, *args) MAPIErrorNetworkError: MAPI error 80040115 (MAPI_E_NETWORK_ERROR) 2017-11-04 17:24:29,284 - search - ERROR - Traceback (most recent call last): File "/usr/lib/python2.7/site-packages/kopano/log.py", line 87, in log_exc try: yield File "/usr/lib/python2.7/site-packages/kopano_search/__init__.py", line 351, in incremental_sync new_state = self.server.sync(importer, self.state, log=self.log) File "/usr/lib/python2.7/site-packages/kopano/server.py", line 566, in sync return _utils.sync(self, self.mapistore, importer, state, log or self.log, max_changes, window=window, begin=begin, end=end, stats=stats) File "/usr/lib/python2.7/site-packages/kopano/utils.py", line 287, in sync exporter.Config(stream, SYNC_NORMAL | SYNC_ASSOCIATED | SYNC_UNICODE, importer, restriction, None, None, 0) File "/usr/lib/python2.7/site-packages/MAPICore.py", line 1341, in Config def Config(self, *args): return _MAPICore.IExchangeExportChanges_Config(self, *args) MAPIErrorNetworkError: MAPI error 80040115 (MAPI_E_NETWORK_ERROR) 2017-11-04 17:24:31,525 - search - INFO - stopping search 2017-11-04 17:37:34,166 - search - INFO - starting search 2017-11-04 17:39:06,308 - search - INFO - found previous server sync state: 4D05010021902103 2017-11-04 17:39:06,314 - search - INFO - starting incremental sync 2017-11-04 17:39:06,356 - query - INFO - listening on socket file:///var/run/kopano/search.sock 2017-11-04 17:39:06,378 - query - INFO - Command: PROPS 2017-11-04 17:39:06,379 - query - INFO - Response: OK:125 100 3102 117 26510 26511 26 2017-11-04 17:39:11,555 - index0 - ERROR - Traceback (most recent call last): File "/usr/lib/python2.7/site-packages/kopano/log.py", line 87, in log_exc try: yield File "/usr/lib/python2.7/site-packages/kopano_search/__init__.py", line 199, in main folder = kopano.Folder(store, folderid) File "/usr/lib/python2.7/site-packages/kopano/folder.py", line 79, in __init__ self.mapiobj = store.mapiobj.OpenEntry(entryid, IID_IMAPIFolder, MAPI_MODIFY) File "/usr/lib/python2.7/site-packages/MAPICore.py", line 441, in OpenEntry def OpenEntry(self, *args): return _MAPICore.IMsgStore_OpenEntry(self, *args) MAPIErrorInvalidEntryid: MAPI error 80040107 (MAPI_E_INVALID_ENTRYID) 2017-11-04 17:39:11,570 - index2 - ERROR - Traceback (most recent call last): File "/usr/lib/python2.7/site-packages/kopano/log.py", line 87, in log_exc try: yield File "/usr/lib/python2.7/site-packages/kopano_search/__init__.py", line 199, in main folder = kopano.Folder(store, folderid) File "/usr/lib/python2.7/site-packages/kopano/folder.py", line 79, in __init__ self.mapiobj = store.mapiobj.OpenEntry(entryid, IID_IMAPIFolder, MAPI_MODIFY) File "/usr/lib/python2.7/site-packages/MAPICore.py", line 441, in OpenEntry def OpenEntry(self, *args): return _MAPICore.IMsgStore_OpenEntry(self, *args) MAPIErrorInvalidEntryid: MAPI error 80040107 (MAPI_E_INVALID_ENTRYID) 2017-11-04 17:39:11,571 - search - INFO - queue processed in 0.06 seconds (0 changes, ~0.00/sec) 2017-11-04 17:39:11,573 - search - INFO - saved server sync state = 4D0501002D902103 2017-11-04 17:39:41,612 - search - INFO - queue processed in 0.00 seconds (0 changes, ~0.00/sec) 2017-11-04 17:39:41,619 - search - INFO - saved server sync state = 4D0501002E902103 2017-11-04 17:40:01,722 - index3 - ERROR - Traceback (most recent call last): File "/usr/lib/python2.7/site-packages/kopano/log.py", line 87, in log_exc try: yield File "/usr/lib/python2.7/site-packages/kopano_search/__init__.py", line 199, in main folder = kopano.Folder(store, folderid) File "/usr/lib/python2.7/site-packages/kopano/folder.py", line 79, in __init__ self.mapiobj = store.mapiobj.OpenEntry(entryid, IID_IMAPIFolder, MAPI_MODIFY) File "/usr/lib/python2.7/site-packages/MAPICore.py", line 441, in OpenEntry def OpenEntry(self, *args): return _MAPICore.IMsgStore_OpenEntry(self, *args) MAPIErrorInvalidEntryid: MAPI error 80040107 (MAPI_E_INVALID_ENTRYID) 2017-11-04 17:40:01,757 - index1 - ERROR - Traceback (most recent call last): File "/usr/lib/python2.7/site-packages/kopano/log.py", line 87, in log_exc try: yield File "/usr/lib/python2.7/site-packages/kopano_search/__init__.py", line 199, in main folder = kopano.Folder(store, folderid) File "/usr/lib/python2.7/site-packages/kopano/folder.py", line 79, in __init__ self.mapiobj = store.mapiobj.OpenEntry(entryid, IID_IMAPIFolder, MAPI_MODIFY) File "/usr/lib/python2.7/site-packages/MAPICore.py", line 441, in OpenEntry def OpenEntry(self, *args): return _MAPICore.IMsgStore_OpenEntry(self, *args) MAPIErrorInvalidEntryid: MAPI error 80040107 (MAPI_E_INVALID_ENTRYID) 2017-11-04 17:40:01,758 - search - INFO - queue processed in 0.06 seconds (0 changes, ~0.00/sec) 2017-11-04 17:40:01,758 - search - INFO - saved server sync state = 4D05010032902103 2017-11-04 17:41:01,907 - index4 - ERROR - Traceback (most recent call last): File "/usr/lib/python2.7/site-packages/kopano/log.py", line 87, in log_exc try: yield File "/usr/lib/python2.7/site-packages/kopano_search/__init__.py", line 199, in main folder = kopano.Folder(store, folderid) File "/usr/lib/python2.7/site-packages/kopano/folder.py", line 79, in __init__ self.mapiobj = store.mapiobj.OpenEntry(entryid, IID_IMAPIFolder, MAPI_MODIFY) File "/usr/lib/python2.7/site-packages/MAPICore.py", line 441, in OpenEntry def OpenEntry(self, *args): return _MAPICore.IMsgStore_OpenEntry(self, *args) MAPIErrorInvalidEntryid: MAPI error 80040107 (MAPI_E_INVALID_ENTRYID)
since then we got MAPI error every minute from each search-worker.
Searching an Item via DeskApp or WebApp results in found items from 04-11-2017 and earlier. All recent items cant be searched!should i reindex my db since the cause seems to be a Network-Error and maybe an unfinished handle. Even updating the packages (+reboot) at 11-11-2017 didnt resolve it.
im a bit afraid that reindexing results in more Mapi errors and nothing can be searched…
//EDIT: seems my thought was right:
just deleted the index on my cloned mailserver:1507176 2017-11-23 16:21:13,528 - search - INFO - starting search 1507177 2017-11-23 16:21:13,593 - search - INFO - starting initial sync 1507178 2017-11-23 16:27:34,415 - search - INFO - queued 7477 folders (~713644 changes) for parallel indexing (5 processes) 1507179 2017-11-23 16:27:34,414 - index1 - ERROR - Traceback (most recent call last): 1507180 File "/usr/lib/python2.7/site-packages/kopano/log.py", line 87, in log_exc 1507181 try: yield 1507182 File "/usr/lib/python2.7/site-packages/kopano_search/__init__.py", line 199, in main 1507183 folder = kopano.Folder(store, folderid) 1507184 File "/usr/lib/python2.7/site-packages/kopano/folder.py", line 79, in __init__ 1507185 self.mapiobj = store.mapiobj.OpenEntry(entryid, IID_IMAPIFolder, MAPI_MODIFY) 1507186 File "/usr/lib/python2.7/site-packages/MAPICore.py", line 441, in OpenEntry 1507187 def OpenEntry(self, *args): return _MAPICore.IMsgStore_OpenEntry(self, *args) 1507188 MAPIErrorInvalidEntryid: MAPI error 80040107 (MAPI_E_INVALID_ENTRYID) 1507189 1507190 2017-11-23 16:27:34,414 - index3 - ERROR - Traceback (most recent call last): 1507191 File "/usr/lib/python2.7/site-packages/kopano/log.py", line 87, in log_exc 1507192 try: yield 1507193 File "/usr/lib/python2.7/site-packages/kopano_search/__init__.py", line 199, in main 1507194 folder = kopano.Folder(store, folderid) 1507195 File "/usr/lib/python2.7/site-packages/kopano/folder.py", line 79, in __init__ 1507196 self.mapiobj = store.mapiobj.OpenEntry(entryid, IID_IMAPIFolder, MAPI_MODIFY) 1507197 File "/usr/lib/python2.7/site-packages/MAPICore.py", line 441, in OpenEntry 1507198 def OpenEntry(self, *args): return _MAPICore.IMsgStore_OpenEntry(self, *args) 1507199 MAPIErrorInvalidEntryid: MAPI error 80040107 (MAPI_E_INVALID_ENTRYID) [...]
coffee_is_life
-
Hello Forum,
ive just done an upgrade to 8.4.4.0-29 on productive server (test-env was updated a while ago), updated all libkc elements (hint for kopano-team, check dependencies, otherwise kopano-server wont start cause of unexpected version from libkcserver-ldap.so module (Version of the plugin “libkcserver-ldap.so” is not the same for the server. Expected 0x80420000 (8.4.2.0), plugin 0x80440000) ), renamed index-folder to start another initial-sync.
This is going to take a while. - My test-env was clean after this, so i think on my productive-system should be good aswell.
i will text if not.coffee_is_life