[horde] iOS Mail Spam support
Twilek
twilek at gmx.de
Tue Oct 23 07:53:03 UTC 2018
> If you provide a sync log, I can investigate. I do know that iOS
> has/had some strange assumptions and requirements >about folder
> names when using ActiveSync, but I can take a look to see for sure
> what is going on with your situation.
@Kevin Thank you for your reply, I seem to have missed your posts back
then, but as you have indicated you didn´t find a satisfactory answer
so maybe it is worth to give it another shot.
@Mike I have turned on detailed active sync logging and then marked a
mail as spam in iOS. Apache und Dovecot logs don´t show anything
interesting. The activesync log is from the moment I marked the
message to the moment when I think it started to resynched everything.
There is a german error message in there "Das Element konnte nicht
gespeichert werden, weil es bereits existiert." which translates to
roughly "The element could not be saved because it already exists." I
have redacted some personal info in the log. I hope this sheds some
light on the problem.
[15035][2018-10-23T07:39:14+00:00] INFO:
----------Horde_Core_ActiveSync_Driver::authenticate() attempt for
twilek----------
[15035][2018-10-23T07:39:14+00:00] INFO: ----------FOLDERCREATE
request received for user twilek
[15035][2018-10-23T07:39:14+00:00] >>>: STATE: Device entry exists for
EH3UOVHI8T0O920KDUT25U6O7K, updating userAgent, version, and supported.
[15035][2018-10-23T07:39:14+00:00] INFO: ----------Request being
handled for device: EH3UOVHI8T0O920KDUT25U6O7K, Supporting protocol
version: 14.1, Using Horde_ActiveSync v2.39.3
[15035][2018-10-23T07:39:14+00:00] >>>: GET VARIABLES: Array
(
[User] => twilek
[DeviceId] => EH3UOVHI8T0O920KDUT25U6O7K
[DeviceType] => iPad
[Cmd] => FolderCreate
)
[15035][2018-10-23T07:39:14+00:00] >>>: Handling
FOLDER[CREATE|DELETE|CHANGE] command.
[15035][2018-10-23T07:39:14+00:00] I: <FolderHierarchy:FolderCreate>
[15035][2018-10-23T07:39:14+00:00] I: <FolderHierarchy:SyncKey>
[15035][2018-10-23T07:39:14+00:00] I:
{5bcecdac-86e8-47e3-9011-2c32bc4426b0}1
[15035][2018-10-23T07:39:14+00:00] I: </FolderHierarchy:SyncKey>
[15035][2018-10-23T07:39:14+00:00] I: <FolderHierarchy:ParentId>
[15035][2018-10-23T07:39:14+00:00] I: 0
[15035][2018-10-23T07:39:14+00:00] I: </FolderHierarchy:ParentId>
[15035][2018-10-23T07:39:14+00:00] I: <FolderHierarchy:DisplayName>
[15035][2018-10-23T07:39:14+00:00] I: Junk
[15035][2018-10-23T07:39:14+00:00] I: </FolderHierarchy:DisplayName>
[15035][2018-10-23T07:39:14+00:00] I: <FolderHierarchy:Type>
[15035][2018-10-23T07:39:14+00:00] I: 12
[15035][2018-10-23T07:39:14+00:00] I: </FolderHierarchy:Type>
[15035][2018-10-23T07:39:14+00:00] I: </FolderHierarchy:FolderCreate>
[15035][2018-10-23T07:39:14+00:00] >>>: Creating new
Horde_ActiveSync_SyncCache.
[15035][2018-10-23T07:39:14+00:00] >>>: STATE: Loading state for
synckey {5bcecdac-86e8-47e3-9011-2c32bc4426b0}1
[15035][2018-10-23T07:39:14+00:00] >>>: STATE: Loading FOLDERSYNC
state containing 45 folders.
[15035][2018-10-23T07:39:14+00:00] >>>:
Horde_ActiveSync_Connector_Importer::importFolderChange(, Junk, 0, 12)
[15035][2018-10-23T07:39:14+00:00] >>>:
Horde_Core_ActiveSync_Driver::changeFolder(, Junk, 0, , 12)
[15035][2018-10-23T07:39:14+00:00] WARN: Mailbox Junk already exists,
subscribing to it.
[15035][2018-10-23T07:39:14+00:00] ERR: Das Element konnte nicht
gespeichert werden, weil es bereits existiert.
[15035][2018-10-23T07:39:14+00:00] ERR: Das Element konnte nicht
gespeichert werden, weil es bereits existiert.
[15035][2018-10-23T07:39:14+00:00] ERR: Das Element konnte nicht
gespeichert werden, weil es bereits existiert.
[15035][2018-10-23T07:39:14+00:00] O: <FolderHierarchy:FolderCreate>
[15035][2018-10-23T07:39:14+00:00] O: <FolderHierarchy:Status>
[15035][2018-10-23T07:39:14+00:00] O: 6
[15035][2018-10-23T07:39:14+00:00] O: </FolderHierarchy:Status>
[15035][2018-10-23T07:39:14+00:00] O: </FolderHierarchy:FolderCreate>
[15035][2018-10-23T07:39:14+00:00] INFO: Maximum memory usage for
ActiveSync request: 2097152 bytes.
[11314][2018-10-23T07:39:14+00:00] INFO:
----------Horde_Core_ActiveSync_Driver::authenticate() attempt for
twilek----------
[11314][2018-10-23T07:39:14+00:00] INFO: ----------FOLDERCREATE
request received for user twilek
[11314][2018-10-23T07:39:14+00:00] >>>: STATE: Device entry exists for
EH3UOVHI8T0O920KDUT25U6O7K, updating userAgent, version, and supported.
[11314][2018-10-23T07:39:14+00:00] INFO: ----------Request being
handled for device: EH3UOVHI8T0O920KDUT25U6O7K, Supporting protocol
version: 14.1, Using Horde_ActiveSync v2.39.3
[11314][2018-10-23T07:39:14+00:00] >>>: GET VARIABLES: Array
(
[User] => twilek
[DeviceId] => EH3UOVHI8T0O920KDUT25U6O7K
[DeviceType] => iPad
[Cmd] => FolderCreate
)
[11314][2018-10-23T07:39:14+00:00] >>>: Handling
FOLDER[CREATE|DELETE|CHANGE] command.
[11314][2018-10-23T07:39:14+00:00] I: <FolderHierarchy:FolderCreate>
[11314][2018-10-23T07:39:14+00:00] I: <FolderHierarchy:SyncKey>
[11314][2018-10-23T07:39:14+00:00] I:
{5bcecdac-86e8-47e3-9011-2c32bc4426b0}1
[11314][2018-10-23T07:39:14+00:00] I: </FolderHierarchy:SyncKey>
[11314][2018-10-23T07:39:14+00:00] I: <FolderHierarchy:ParentId>
[11314][2018-10-23T07:39:14+00:00] I: 0
[11314][2018-10-23T07:39:14+00:00] I: </FolderHierarchy:ParentId>
[11314][2018-10-23T07:39:14+00:00] I: <FolderHierarchy:DisplayName>
[11314][2018-10-23T07:39:14+00:00] I: Junk
[11314][2018-10-23T07:39:14+00:00] I: </FolderHierarchy:DisplayName>
[11314][2018-10-23T07:39:14+00:00] I: <FolderHierarchy:Type>
[11314][2018-10-23T07:39:14+00:00] I: 12
[11314][2018-10-23T07:39:14+00:00] I: </FolderHierarchy:Type>
[11314][2018-10-23T07:39:14+00:00] I: </FolderHierarchy:FolderCreate>
[11314][2018-10-23T07:39:14+00:00] >>>: Creating new
Horde_ActiveSync_SyncCache.
[11314][2018-10-23T07:39:14+00:00] >>>: STATE: Loading state for
synckey {5bcecdac-86e8-47e3-9011-2c32bc4426b0}1
[11314][2018-10-23T07:39:14+00:00] >>>: STATE: Loading FOLDERSYNC
state containing 45 folders.
[11314][2018-10-23T07:39:14+00:00] >>>:
Horde_ActiveSync_Connector_Importer::importFolderChange(, Junk, 0, 12)
[11314][2018-10-23T07:39:14+00:00] >>>:
Horde_Core_ActiveSync_Driver::changeFolder(, Junk, 0, , 12)
[11314][2018-10-23T07:39:14+00:00] WARN: Mailbox Junk already exists,
subscribing to it.
[11314][2018-10-23T07:39:14+00:00] ERR: Das Element konnte nicht
gespeichert werden, weil es bereits existiert.
[11314][2018-10-23T07:39:14+00:00] ERR: Das Element konnte nicht
gespeichert werden, weil es bereits existiert.
[11314][2018-10-23T07:39:14+00:00] ERR: Das Element konnte nicht
gespeichert werden, weil es bereits existiert.
[11314][2018-10-23T07:39:14+00:00] O: <FolderHierarchy:FolderCreate>
[11314][2018-10-23T07:39:14+00:00] O: <FolderHierarchy:Status>
[11314][2018-10-23T07:39:14+00:00] O: 6
[11314][2018-10-23T07:39:14+00:00] O: </FolderHierarchy:Status>
[11314][2018-10-23T07:39:14+00:00] O: </FolderHierarchy:FolderCreate>
[11314][2018-10-23T07:39:14+00:00] INFO: Maximum memory usage for
ActiveSync request: 2097152 bytes.
[15037][2018-10-23T07:39:15+00:00] INFO:
----------Horde_Core_ActiveSync_Driver::authenticate() attempt for
twilek----------
[15037][2018-10-23T07:39:15+00:00] INFO: ----------FOLDERSYNC request
received for user twilek
[15037][2018-10-23T07:39:15+00:00] >>>: STATE: Device entry exists for
EH3UOVHI8T0O920KDUT25U6O7K, updating userAgent, version, and supported.
[15037][2018-10-23T07:39:15+00:00] INFO: ----------Request being
handled for device: EH3UOVHI8T0O920KDUT25U6O7K, Supporting protocol
version: 14.1, Using Horde_ActiveSync v2.39.3
[15037][2018-10-23T07:39:15+00:00] >>>: GET VARIABLES: Array
(
[User] => twilek
[DeviceId] => EH3UOVHI8T0O920KDUT25U6O7K
[DeviceType] => iPad
[Cmd] => FolderSync
)
[15037][2018-10-23T07:39:15+00:00] >>>: Handling FOLDERSYNC command.
[15037][2018-10-23T07:39:15+00:00] >>>: Checking policykey for device:
EH3UOVHI8T0O920KDUT25U6O7K user: twilek
[15037][2018-10-23T07:39:15+00:00] INFO: Policykey: 0 verified.
[15037][2018-10-23T07:39:15+00:00] I: <FolderHierarchy:FolderSync>
[15037][2018-10-23T07:39:15+00:00] I: <FolderHierarchy:SyncKey>
[15037][2018-10-23T07:39:15+00:00] I: 0
[15037][2018-10-23T07:39:15+00:00] I: </FolderHierarchy:SyncKey>
[15037][2018-10-23T07:39:15+00:00] >>>: Creating new
Horde_ActiveSync_SyncCache.
[15037][2018-10-23T07:39:15+00:00] NOTICE:
Horde_ActiveSync_State_Base::loadState: clearing folder state.
[15037][2018-10-23T07:39:15+00:00] >>>: STATE: Resetting device state
for device: EH3UOVHI8T0O920KDUT25U6O7K, user: twilek, and collection:
foldersync.
[15037][2018-10-23T07:39:15+00:00] >>>: Creating new
Horde_ActiveSync_SyncCache.
[15037][2018-10-23T07:39:15+00:00] NOTICE: STATE: Clearing foldersync
state from synccache.
[15037][2018-10-23T07:39:15+00:00] >>>: Clearing collections data from cache.
[15037][2018-10-23T07:39:15+00:00] >>>: STATE: Replacing SYNC_CACHE
entry for user twilek and device EH3UOVHI8T0O920KDUT25U6O7K:
a:11:{s:18:"confirmed_synckeys";a:1:{s:39:"{5bcecff2-af54-4744-8a89-3eedbc442$
[15037][2018-10-23T07:39:15+00:00] I: </FolderHierarchy:FolderSync>
[15037][2018-10-23T07:39:15+00:00] >>>: STATE: Initializing folder diff engine
[15037][2018-10-23T07:39:15+00:00] >>>:
Horde_Core_ActiveSync_Driver::getFolderList()
[15037][2018-10-23T09:39:15+02:00] >>>: Creating new folder uuid for
Calendar:P9lpdOmkpHVOE3ZazA7FVjA: A69eeea86
[15037][2018-10-23T09:39:15+02:00] >>>: Creating new folder uuid for
Calendar:JembTemkpHVOE4IatLR3YkA: Aa082f64c
[15037][2018-10-23T09:39:15+02:00] >>>: Creating new folder uuid for
Calendar:BjZpCOmkpHVOE3YJR0NFVjA: A67c624a0
[15037][2018-10-23T09:39:15+02:00] >>>: Creating new folder uuid for
Calendar:iutCW_mkpHVOE4Iul793YkA: Ab9febb32
[15037][2018-10-23T09:39:15+02:00] >>>: Creating new folder uuid for
Calendar:rrixBemkpHVOE3Xt2uTlVjA: A289656ed
[15037][2018-10-23T09:39:15+02:00] >>>: Creating new folder uuid for
Calendar:bZVDdOmkpHVOE3Y_nhclVjA: Ac6ac1a13
[15037][2018-10-23T09:39:15+02:00] >>>: Creating new folder uuid for
Contacts:35398753d7d06da67e7228b547ac8cd0: Ce471caac
[15037][2018-10-23T09:39:15+02:00] >>>: Creating new folder uuid for
Contacts:qDW02dCSPmLn2rKJ1cGtSYw: C9343af7f
[15037][2018-10-23T09:39:15+02:00] >>>: Creating new folder uuid for
Tasks:JmFL6zJrQlKCrnZyH24i9KQ: T1bda47bc
[15037][2018-10-23T09:39:15+02:00] >>>: Creating new folder uuid for
Tasks:twilek: Tb6aa04b6
[15037][2018-10-23T09:39:15+02:00] >>>: Creating new folder uuid for
@Notes@: N2a6e5966
[15037][2018-10-23T09:39:15+02:00] >>>: Polling
Horde_Core_ActiveSync_Driver::_getMailFolders()
[15037][2018-10-23T09:39:15+02:00] >>>: Creating new folder uuid for
INBOX: F9cbc1cc3
[15037][2018-10-23T09:39:15+02:00] >>>: Creating new folder uuid for
Axxxr: F709124f8
[15037][2018-10-23T09:39:15+02:00] >>>: Creating new folder uuid for
x: F507e46b4
[15037][2018-10-23T09:39:15+02:00] >>>: Creating new folder uuid for
Arbeit: F2f5ebf4f
[15037][2018-10-23T09:39:15+02:00] >>>: Creating new folder uuid for
Archive: F6369de72
[15037][2018-10-23T09:39:15+02:00] >>>: Creating new folder uuid for
Cxxs: F8a88b349
[15037][2018-10-23T09:39:15+02:00] >>>: Creating new folder uuid for
Cron: F09e21606
[15037][2018-10-23T09:39:15+02:00] >>>: Creating new folder uuid for
xx: Fe56f5ecc
[15037][2018-10-23T09:39:15+02:00] >>>: Creating new folder uuid for
Ebay: Fdeb3928c
[15037][2018-10-23T09:39:15+02:00] >>>: Creating new folder uuid for
x: F0533c291
[15037][2018-10-23T09:39:15+02:00] >>>: Creating new folder uuid for
Drafts: Fc4d6eec6
[15037][2018-10-23T09:39:15+02:00] >>>: Creating new folder uuid for
Sent Messages: F7536e9f6
[15037][2018-10-23T09:39:15+02:00] >>>: Creating new folder uuid for
Haus: F627e0d93
[15037][2018-10-23T09:39:15+02:00] >>>: Creating new folder uuid for
Horde: F325801f6
[15037][2018-10-23T09:39:15+02:00] >>>: Creating new folder uuid for
xxx: Fb514ccfe
[15037][2018-10-23T09:39:15+02:00] >>>: Creating new folder uuid for
xxx: Fa14d5508
More information about the horde
mailing list