[2011-01-26 18:28:15,815] [funambol.transport.http] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [] [] [] Handling incoming request
[2011-01-26 18:28:15,929] [funambol.transport.http] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [] [] [] Request URL: http://xx/funambol/ds
[2011-01-26 18:28:15,929] [funambol.transport.http] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [] [] [] Requested sessionId: null
[2011-01-26 18:28:18,333] [funambol.handler] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] user/IMEI:351940032285111 logged in.
[2011-01-26 18:28:18,449] [funambol.handler] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] moving to state: STATE_PKG1_RECEIVING
[2011-01-26 18:28:18,834] [funambol.sogo] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] Source URI: cal
[2011-01-26 18:28:18,835] [funambol.sogo] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] Done! Internal item type: 2 (text/x-vevent)
[2011-01-26 18:28:18,901] [funambol.handler] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] moving to state: STATE_PKG3_RECEIVING
[2011-01-26 18:28:19,402] [funambol.engine.pipeline] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] Output processing stopped by com.funambol.foundation.synclet.BeanShellSynclet@249fe45c[script=com/funambol/server/engine/pipeline/phones-support/bsh/NokiaS60out.bsh,header=user-agent,pattern=Nokia SyncML HTTP Client|S60 SyncML HTTP Client] (reason: NokiaS60out Synclet finished)
[2011-01-26 18:28:19,495] [funambol.transport.http] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] Request processed.
[2011-01-26 18:28:20,295] [funambol.transport.http] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] Handling incoming request
[2011-01-26 18:28:20,317] [funambol.transport.http] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] Request URL: http://xx/funambol/ds
[2011-01-26 18:28:20,317] [funambol.transport.http] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] Requested sessionId: 45254CE6720D81E0740AA851CED89B08
[2011-01-26 18:28:21,784] [funambol.engine] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] Starting synchronization ...
[2011-01-26 18:28:21,787] [funambol.sogo] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [cal] In beginSync()...
[2011-01-26 18:28:21,797] [funambol.sogo] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [cal] Loading the JDBC driver for URL: jdbc:postgresql:///sogo
[2011-01-26 18:28:22,035] [funambol.sogo] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [cal] Context's user ID: user
[2011-01-26 18:28:22,052] [funambol.sogo] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [cal] Context sync mode: 200
[2011-01-26 18:28:22,052] [funambol.sogo] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [cal] Context conflict resolution: 1
[2011-01-26 18:28:22,053] [funambol.sogo] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [cal] Context query: null
[2011-01-26 18:28:22,178] [funambol.sogo] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [cal] Device's charset: UTF-8
[2011-01-26 18:28:22,178] [funambol.sogo] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [cal] Device's timezone: null
[2011-01-26 18:28:22,178] [funambol.engine.strategy] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [cal] Preparing fast synchronization since 2011-01-26 18:19:32.569
[2011-01-26 18:28:22,186] [funambol.sogo] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [cal] getNewItemKeys(2011-01-26 18:19:32.569(1296062372), 2011-01-26 18:28:17.563(1296062897))
[2011-01-26 18:28:22,205] [funambol.sogo] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [cal] getNewSyncItemKeys():  { keyValue: 5C6C-4D405900-117-64710480.ics } (sogouser0022d915832)
[2011-01-26 18:28:22,206] [funambol.sogo] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [cal] getUpdatedSyncItemKeys(2011-01-26 18:19:32.569(1296062372), 2011-01-26 18:28:17.563(1296062897))
[2011-01-26 18:28:22,221] [funambol.sogo] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [cal] getDeletedItemKeys(2011-01-26 18:19:32.569(1296062372), 2011-01-26 18:28:17.563(1296062897))
[2011-01-26 18:28:22,224] [funambol.sogo] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [cal] getDeletedSyncItemKeys():  { keyValue: 317 } (sogouser0022d915832)
[2011-01-26 18:28:22,226] [funambol.engine.strategy] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [cal] Preparation completed (last message in the package)
[2011-01-26 18:28:22,226] [funambol.engine.strategy] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [cal] Synchronizing...
[2011-01-26 18:28:22,233] [funambol.sogo] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [cal] In commitSync()...
[2011-01-26 18:28:22,320] [funambol.handler] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] moving to state: STATE_PKG3_RECEIVED
[2011-01-26 18:28:22,471] [funambol.engine.pipeline] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] Output processing stopped by com.funambol.foundation.synclet.BeanShellSynclet@249fe45c[script=com/funambol/server/engine/pipeline/phones-support/bsh/NokiaS60out.bsh,header=user-agent,pattern=Nokia SyncML HTTP Client|S60 SyncML HTTP Client] (reason: NokiaS60out Synclet finished)
[2011-01-26 18:28:22,478] [funambol.transport.http] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] Request processed.
[2011-01-26 18:28:22,868] [funambol.transport.http] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] Handling incoming request
[2011-01-26 18:28:22,869] [funambol.transport.http] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] Request URL: http://xx/funambol/ds
[2011-01-26 18:28:22,869] [funambol.transport.http] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] Requested sessionId: 45254CE6720D81E0740AA851CED89B08
[2011-01-26 18:28:23,022] [funambol.sogo] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [cal] getSyncItemFromId( { keyValue: 5C6C-4D405900-117-64710480.ics } )
[2011-01-26 18:28:23,037] [funambol.sogo] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [cal] Preferred item type: 1
[2011-01-26 18:28:23,038] [funambol.sogo] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [cal] must secure? false
[2011-01-26 18:28:23,038] [funambol.sogo] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [cal] About to convert vCalendar (from v2 to v1): BEGIN:VCALENDAR
VERSION:2.0
PRODID:-//Inverse inc./SOGo 1.0//EN
BEGIN:VEVENT
UID:5C6C-4D405900-117-64710480
SUMMARY:Sogo défaut alarme
LOCATION:Mon bureau
DESCRIPTION:test de non transfert de l'alarme de Sogo vers Téléphone
CREATED:20110126T172522Z
DTSTAMP:20110126T172522Z
LAST-MODIFIED:20110126T172522Z
BEGIN:VALARM
TRIGGER;VALUE=DURATION:-PT15M
ACTION:DISPLAY
END:VALARM
DTSTART;TZID=/inverse.ca/20101018_1/Europe/Paris:20110127T090000
DTEND;TZID=/inverse.ca/20101018_1/Europe/Paris:20110127T100000
TRANSP:OPAQUE
END:VEVENT
BEGIN:VTIMEZONE
TZID:/inverse.ca/20101018_1/Europe/Paris
X-LIC-LOCATION:Europe/Paris
BEGIN:DAYLIGHT
TZOFFSETFROM:+0100
TZOFFSETTO:+0200
TZNAME:CEST
DTSTART:19700329T020000
RRULE:FREQ=YEARLY;BYMONTH=3;BYDAY=-1SU
END:DAYLIGHT
BEGIN:STANDARD
TZOFFSETFROM:+0200
TZOFFSETTO:+0100
TZNAME:CET
DTSTART:19701025T030000
RRULE:FREQ=YEARLY;BYMONTH=10;BYDAY=-1SU
END:STANDARD
END:VTIMEZONE
END:VCALENDAR
[2011-01-26 18:28:23,051] [funambol.sogo] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [cal] in aAlarmCleanup(), s on input is:BEGIN:VCALENDAR
VERSION:2.0
PRODID:-//Inverse inc./SOGo 1.0//EN
BEGIN:VEVENT
UID:5C6C-4D405900-117-64710480
SUMMARY:Sogo défaut alarme
LOCATION:Mon bureau
DESCRIPTION:test de non transfert de l'alarme de Sogo vers Téléphone
CREATED:20110126T172522Z
DTSTAMP:20110126T172522Z
LAST-MODIFIED:20110126T172522Z
BEGIN:VALARM
TRIGGER;VALUE=DURATION:-PT15M
ACTION:DISPLAY
END:VALARM
DTSTART;TZID=/inverse.ca/20101018_1/Europe/Paris:20110127T090000
DTEND;TZID=/inverse.ca/20101018_1/Europe/Paris:20110127T100000
TRANSP:0
END:VEVENT
BEGIN:VTIMEZONE
TZID:/inverse.ca/20101018_1/Europe/Paris
X-LIC-LOCATION:Europe/Paris
BEGIN:DAYLIGHT
TZOFFSETFROM:+0100
TZOFFSETTO:+0200
TZNAME:CEST
DTSTART:19700329T020000
RRULE:FREQ=YEARLY;BYMONTH=3;BYDAY=-1SU
END:DAYLIGHT
BEGIN:STANDARD
TZOFFSETFROM:+0200
TZOFFSETTO:+0100
TZNAME:CET
DTSTART:19701025T030000
RRULE:FREQ=YEARLY;BYMONTH=10;BYDAY=-1SU
END:STANDARD
END:VTIMEZONE
END:VCALENDAR
[2011-01-26 18:28:23,072] [funambol.sogo] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [cal] after aAlarmCleanup(), ret value is:BEGIN:VCALENDAR
VERSION:2.0
PRODID:-//Inverse inc./SOGo 1.0//EN
BEGIN:VEVENT
UID:5C6C-4D405900-117-64710480
SUMMARY:Sogo défaut alarme
LOCATION:Mon bureau
DESCRIPTION:test de non transfert de l'alarme de Sogo vers Téléphone
CREATED:20110126T172522Z
DTSTAMP:20110126T172522Z
LAST-MODIFIED:20110126T172522Z
BEGIN:VALARM
TRIGGER;VALUE=DURATION:-PT15M
ACTION:DISPLAY
END:VALARM
DTSTART;TZID=/inverse.ca/20101018_1/Europe/Paris:20110127T090000
DTEND;TZID=/inverse.ca/20101018_1/Europe/Paris:20110127T100000
TRANSP:0
END:VEVENT
BEGIN:VTIMEZONE
TZID:/inverse.ca/20101018_1/Europe/Paris
X-LIC-LOCATION:Europe/Paris
BEGIN:DAYLIGHT
TZOFFSETFROM:+0100
TZOFFSETTO:+0200
TZNAME:CEST
DTSTART:19700329T020000
RRULE:FREQ=YEARLY;BYMONTH=3;BYDAY=-1SU
END:DAYLIGHT
BEGIN:STANDARD
TZOFFSETFROM:+0200
TZOFFSETTO:+0100
TZNAME:CET
DTSTART:19701025T030000
RRULE:FREQ=YEARLY;BYMONTH=10;BYDAY=-1SU
END:STANDARD
END:VTIMEZONE
END:VCALENDAR

[2011-01-26 18:28:23,581] [funambol.sogo] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [cal] VALARM is: TRIGGER;VALUE=DURATION:-PT15M
ACTION:DISPLAY

[2011-01-26 18:28:23,590] [funambol.sogo] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [cal] BEGIN:VCALENDAR
PRODID:-//Inverse inc./SOGo 1.0//EN
VERSION:1.0
TZ:+0100
DAYLIGHT:TRUE;+0200;20100328T020000;20101031T030000;Europe/Paris;Europe/Paris
DAYLIGHT:TRUE;+0200;20110327T020000;20111030T030000;Europe/Paris;Europe/Paris
DAYLIGHT:TRUE;+0200;20120325T020000;20121028T030000;Europe/Paris;Europe/Paris
DAYLIGHT:TRUE;+0200;20130331T020000;20131027T030000;Europe/Paris;Europe/Paris
BEGIN:VEVENT
UID:5C6C-4D405900-117-64710480
SUMMARY;ENCODING=QUOTED-PRINTABLE;CHARSET=UTF-8:Sogo d=C3=A9faut alarme
DESCRIPTION;ENCODING=QUOTED-PRINTABLE;CHARSET=UTF-8:test de non transfert de l'alarme de Sogo vers T=C3=A9l=C3=A9phone
LOCATION:Mon bureau
CLASS:PUBLIC
DTSTART:20110127T080000Z
DTEND:20110127T090000Z
TRANSP:0
LAST-MODIFIED:20110126T172522Z
X-FUNAMBOL-ALLDAY:0
AALARM:-PT15M
END:VEVENT
END:VCALENDAR

[2011-01-26 18:28:23,641] [funambol.handler] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] moving to state: STATE_PKG1_RECEIVING
[2011-01-26 18:28:23,748] [funambol.engine.pipeline] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] Output processing stopped by com.funambol.foundation.synclet.BeanShellSynclet@249fe45c[script=com/funambol/server/engine/pipeline/phones-support/bsh/NokiaS60out.bsh,header=user-agent,pattern=Nokia SyncML HTTP Client|S60 SyncML HTTP Client] (reason: NokiaS60out Synclet finished)
[2011-01-26 18:28:23,750] [funambol.transport.http] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] Request processed.
[2011-01-26 18:28:24,405] [funambol.transport.http] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] Handling incoming request
[2011-01-26 18:28:24,406] [funambol.transport.http] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] Request URL: http://xx/funambol/ds
[2011-01-26 18:28:24,406] [funambol.transport.http] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] Requested sessionId: 45254CE6720D81E0740AA851CED89B08
[2011-01-26 18:28:24,506] [funambol.sogo] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [cal] Received status code '201' for a 'Add' for this items (1):
- 5C6C-4D405900-117-64710480.ics
[2011-01-26 18:28:24,532] [funambol.handler] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] moving to state: STATE_PKG3_RECEIVING
[2011-01-26 18:28:24,532] [funambol.handler] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] moving to state: STATE_END
[2011-01-26 18:28:24,532] [funambol.engine.source] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [cal] cal: 0 new items added, 0 existing items updated, 0 items deleted.
[2011-01-26 18:28:24,532] [funambol.sogo] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [cal] In endSync()...
[2011-01-26 18:28:24,532] [funambol.sogo] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [cal] Closed the database connection.
[2011-01-26 18:28:24,556] [funambol.handler] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] moving to state: STATE_ENDED
[2011-01-26 18:28:24,558] [funambol.handler] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] Synchronization completed
[2011-01-26 18:28:24,663] [funambol.engine.pipeline] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] Output processing stopped by com.funambol.foundation.synclet.BeanShellSynclet@249fe45c[script=com/funambol/server/engine/pipeline/phones-support/bsh/NokiaS60out.bsh,header=user-agent,pattern=Nokia SyncML HTTP Client|S60 SyncML HTTP Client] (reason: NokiaS60out Synclet finished)
[2011-01-26 18:28:24,665] [funambol.transport.http] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] Request processed.
[2011-01-26 18:28:24,666] [funambol.transport.http] [INFO] [45254CE6720D81E0740AA851CED89B08] [62.201.142.25] [IMEI:351940032285111] [user] [] Closing session 45254CE6720D81E0740AA851CED89B08