Module loader shows nothing after upload of custom package

after uploading a module in module loader for 6.5.15 for MailMergeReports-Basic-v2.0.5-Sugar_6.5.zip nothing shows up...just goes to a blank screen with sales / home...and nothing...when you goto the module loader nothing shows up on that section either...

Sat Mar  1 19:52:03 2014 [42337][-none-][DEBUG] current_language is: en_us
Sat Mar  1 19:52:03 2014 [42337][-none-][DEBUG] Found cache backend SugarCachesMash
Sat Mar  1 19:52:03 2014 [42337][-none-][DEBUG] Found cache backend SugarCacheAPC
Sat Mar  1 19:52:03 2014 [42337][-none-][DEBUG] Using cache backend SugarCacheAPC, since 940 is less than 1000
Sat Mar  1 19:52:03 2014 [42337][-none-][DEBUG] Found cache backend SugarCacheFile
Sat Mar  1 19:52:03 2014 [42337][-none-][DEBUG] Found cache backend SugarCacheMemcache
Sat Mar  1 19:52:03 2014 [42337][-none-][DEBUG] Found cache backend SugarCacheMemcached
Sat Mar  1 19:52:03 2014 [42337][-none-][DEBUG] Found cache backend SugarCacheMemory
Sat Mar  1 19:52:03 2014 [42337][-none-][DEBUG] Found cache backend SugarCacheRedis
Sat Mar  1 19:52:03 2014 [42337][-none-][DEBUG] Found cache backend SugarCacheWincache
Sat Mar  1 19:52:03 2014 [42337][-none-][DEBUG] Found cache backend SugarCacheZend
Sat Mar  1 19:52:03 2014 [42337][-none-][INFO] Query:SELECT category, name, value FROM config
Sat Mar  1 19:52:03 2014 [42337][-none-][INFO] Query Execution Time:0.00024199485778809
Sat Mar  1 19:52:03 2014 [42337][-none-][INFO] Query:SELECT id FROM outbound_email WHERE type = 'system'
Sat Mar  1 19:52:03 2014 [42337][-none-][INFO] Query Execution Time:0.00014495849609375
Sat Mar  1 19:52:03 2014 [42337][-none-][INFO] Query:SELECT * FROM outbound_email WHERE id = '94a6de96-23ab-1203-3647-530f41d556ac'
Sat Mar  1 19:52:03 2014 [42337][-none-][INFO] Query Execution Time:0.00012397766113281
Sat Mar  1 19:52:03 2014 [42337][-none-][DEBUG] Hook called: ::after_entry_point
Sat Mar  1 19:52:03 2014 [42337][-none-][DEBUG] Including Ext hook file for custom/application
Sat Mar  1 19:52:03 2014 [42337][-none-][DEBUG] Hook called: ::after_session_start
Sat Mar  1 19:52:03 2014 [42337][-none-][DEBUG] We have an authenticated user id: 1
Sat Mar  1 19:52:03 2014 [42337][-none-][DEBUG] Hook called: Users::before_retrieve
Sat Mar  1 19:52:03 2014 [42337][-none-][DEBUG] Including module specific hook file for custom/modules/Users
Sat Mar  1 19:52:03 2014 [42337][-none-][DEBUG] Retrieve User : SELECT users.* FROM users  WHERE users.id = '1' AND users.deleted=0
Sat Mar  1 19:52:03 2014 [42337][-none-][DEBUG] Limit Query:SELECT users.* FROM users  WHERE users.id = '1' AND users.deleted=0 Start: 0 count: 1
Sat Mar  1 19:52:03 2014 [42337][-none-][INFO] Query:SELECT users.* FROM users  WHERE users.id = '1' AND users.deleted=0 LIMIT 0,1
Sat Mar  1 19:52:03 2014 [42337][-none-][INFO] Query Execution Time:0.00023198127746582
Sat Mar  1 19:52:03 2014 [42337][1][INFO] Query:SELECT u1.first_name, u1.last_name from users  u1, users  u2 where u1.id = u2.reports_to_id AND u2.id = '1' and u1.deleted=0
Sat Mar  1 19:52:03 2014 [42337][1][INFO] Query Execution Time:0.00018095970153809
Sat Mar  1 19:52:03 2014 [42337][1][DEBUG] SugarBean[User].load_relationships, Loading relationship (reports_to_link).
Sat Mar  1 19:52:03 2014 [42337][1][INFO] Query:SELECT ea.email_address, ea.email_address_caps, ea.invalid_email, ea.opt_out, ea.date_created, ea.date_modified,
                ear.id, ear.email_address_id, ear.bean_id, ear.bean_module, ear.primary_address, ear.reply_to_address, ear.deleted
                FROM email_addresses ea LEFT JOIN email_addr_bean_rel ear ON ea.id = ear.email_address_id
                WHERE ear.bean_module = 'Users'
                AND ear.bean_id = '1'
                AND ear.deleted = 0
                ORDER BY ear.reply_to_address, ear.primary_address DESC
Sat Mar  1 19:52:03 2014 [42337][1][INFO] Query Execution Time:0.00031590461730957
Sat Mar  1 19:52:03 2014 [42337][1][DEBUG] Hook called: Users::after_retrieve
Sat Mar  1 19:52:03 2014 [42337][1][DEBUG] Current user is: admin
Sat Mar  1 19:52:03 2014 [42337][1][DEBUG] Current user is: admin
Sat Mar  1 19:52:03 2014 [42337][1][DEBUG] setting cookie ck_login_id_20 to 1
Sat Mar  1 19:52:03 2014 [42337][1][DEBUG] setting cookie ck_login_language_20 to en_us
Sat Mar  1 19:52:03 2014 [42337][1][DEBUG] current_language is: en_us
Sat Mar  1 19:52:03 2014 [42337][1][INFO] Query:SELECT category, name, value FROM config WHERE category = 'license'
Sat Mar  1 19:52:03 2014 [42337][1][INFO] Query Execution Time:0.00019598007202148
Sat Mar  1 19:52:03 2014 [42337][1][INFO] Query:SELECT id FROM outbound_email WHERE type = 'system'
Sat Mar  1 19:52:03 2014 [42337][1][INFO] Query Execution Time:9.7990036010742E-5
Sat Mar  1 19:52:03 2014 [42337][1][INFO] Query:SELECT * FROM outbound_email WHERE id = '94a6de96-23ab-1203-3647-530f41d556ac'
Sat Mar  1 19:52:03 2014 [42337][1][INFO] Query Execution Time:0.00011897087097168
Sat Mar  1 19:52:03 2014 [42337][1][DEBUG] Module:Administration using file: UpgradeWizard
Sat Mar  1 19:52:03 2014 [42337][1][INFO] Query:SELECT category, name, value FROM config WHERE category = 'tracker'
Sat Mar  1 19:52:03 2014 [42337][1][INFO] Query Execution Time:0.00016903877258301
Sat Mar  1 19:52:03 2014 [42337][1][INFO] Query:SELECT id FROM outbound_email WHERE type = 'system'
Sat Mar  1 19:52:03 2014 [42337][1][INFO] Query Execution Time:9.7990036010742E-5
Sat Mar  1 19:52:03 2014 [42337][1][INFO] Query:SELECT * FROM outbound_email WHERE id = '94a6de96-23ab-1203-3647-530f41d556ac'
Sat Mar  1 19:52:03 2014 [42337][1][INFO] Query Execution Time:0.00011801719665527
Sat Mar  1 19:52:03 2014 [42337][1][WARN] Image icon_Administration_32.png not found
Sat Mar  1 19:52:03 2014 [42337][1][WARN] Image icon_Administration_32.png not found
Sat Mar  1 19:52:03 2014 [42337][1][DEBUG] Limit Query:SELECT item_id, item_summary, module_name, id FROM tracker WHERE id = (SELECT MAX(id) as id FROM tracker WHERE user_id = '1' AND deleted = 0 AND visible = 1) Start: 0 count: 50
Sat Mar  1 19:52:03 2014 [42337][1][INFO] Query:SELECT item_id, item_summary, module_name, id FROM tracker WHERE id = (SELECT MAX(id) as id FROM tracker WHERE user_id = '1' AND deleted = 0 AND visible = 1) LIMIT 0,50
Sat Mar  1 19:52:03 2014 [42337][1][INFO] Query Execution Time:0.00032305717468262
Sat Mar  1 19:52:03 2014 [42337][1][INFO] Tracker: retrieving 10 items
Sat Mar  1 19:52:03 2014 [42337][1][INFO] Query:SELECT category, name, value FROM config WHERE category = 'MySettings'
Sat Mar  1 19:52:03 2014 [42337][1][INFO] Query Execution Time:0.0001671314239502
Sat Mar  1 19:52:03 2014 [42337][1][INFO] Query:SELECT id FROM outbound_email WHERE type = 'system'
Sat Mar  1 19:52:03 2014 [42337][1][INFO] Query Execution Time:9.8943710327148E-5
Sat Mar  1 19:52:03 2014 [42337][1][INFO] Query:SELECT * FROM outbound_email WHERE id = '94a6de96-23ab-1203-3647-530f41d556ac'
Sat Mar  1 19:52:03 2014 [42337][1][INFO] Query Execution Time:0.00012087821960449
Sat Mar  1 19:52:03 2014 [42337][1][WARN] Image dashboard.png not found
Sat Mar  1 19:52:03 2014 [42337][1][DEBUG] Hook called: ::server_round_trip
Sat Mar  1 19:52:03 2014 [42337][1][DEBUG] Calling MySQLi::disconnect()
Sat Mar  1 19:58:21 2014 [42337][-none-][DEBUG] current_language is: en_us
Sat Mar  1 19:58:21 2014 [42337][-none-][DEBUG] Found cache backend SugarCachesMash
Sat Mar  1 19:58:21 2014 [42337][-none-][DEBUG] Found cache backend SugarCacheAPC
Sat Mar  1 19:58:21 2014 [42337][-none-][DEBUG] Using cache backend SugarCacheAPC, since 940 is less than 1000
Sat Mar  1 19:58:21 2014 [42337][-none-][DEBUG] Found cache backend SugarCacheFile
Sat Mar  1 19:58:21 2014 [42337][-none-][DEBUG] Found cache backend SugarCacheMemcache
Sat Mar  1 19:58:21 2014 [42337][-none-][DEBUG] Found cache backend SugarCacheMemcached
Sat Mar  1 19:58:21 2014 [42337][-none-][DEBUG] Found cache backend SugarCacheMemory
Sat Mar  1 19:58:21 2014 [42337][-none-][DEBUG] Found cache backend SugarCacheRedis
Sat Mar  1 19:58:21 2014 [42337][-none-][DEBUG] Found cache backend SugarCacheWincache
Sat Mar  1 19:58:21 2014 [42337][-none-][DEBUG] Found cache backend SugarCacheZend
Sat Mar  1 19:58:21 2014 [42337][-none-][INFO] Found language file: en_us.lang.php
Sat Mar  1 19:58:21 2014 [42337][-none-][INFO] Query:SELECT id, name, symbol, conversion_rate FROM currencies WHERE status = 'Active' and deleted = 0
Sat Mar  1 19:58:21 2014 [42337][-none-][INFO] Query Execution Time:0.00028014183044434
Sat Mar  1 19:58:21 2014 [42337][-none-][INFO] Query:SELECT category, name, value FROM config
Sat Mar  1 19:58:21 2014 [42337][-none-][INFO] Query Execution Time:0.00021195411682129
Sat Mar  1 19:58:21 2014 [42337][-none-][INFO] Query:SELECT id FROM outbound_email WHERE type = 'system'
Sat Mar  1 19:58:21 2014 [42337][-none-][INFO] Query Execution Time:0.00014400482177734
Sat Mar  1 19:58:21 2014 [42337][-none-][INFO] Query:SELECT * FROM outbound_email WHERE id = '94a6de96-23ab-1203-3647-530f41d556ac'
Sat Mar  1 19:58:21 2014 [42337][-none-][INFO] Query Execution Time:0.00013494491577148
Sat Mar  1 19:58:21 2014 [42337][-none-][DEBUG] Hook called: ::after_entry_point
Sat Mar  1 19:58:21 2014 [42337][-none-][DEBUG] Including Ext hook file for custom/application
Sat Mar  1 19:58:21 2014 [42337][-none-][DEBUG] Hook called: ::after_session_start
Sat Mar  1 19:58:21 2014 [42337][-none-][DEBUG] We have an authenticated user id: 1
Sat Mar  1 19:58:21 2014 [42337][-none-][DEBUG] Hook called: Users::before_retrieve
Sat Mar  1 19:58:21 2014 [42337][-none-][DEBUG] Including module specific hook file for custom/modules/Users
Sat Mar  1 19:58:21 2014 [42337][-none-][DEBUG] Retrieve User : SELECT users.* FROM users  WHERE users.id = '1' AND users.deleted=0
Sat Mar  1 19:58:21 2014 [42337][-none-][DEBUG] Limit Query:SELECT users.* FROM users  WHERE users.id = '1' AND users.deleted=0 Start: 0 count: 1
Sat Mar  1 19:58:21 2014 [42337][-none-][INFO] Query:SELECT users.* FROM users  WHERE users.id = '1' AND users.deleted=0 LIMIT 0,1
Sat Mar  1 19:58:21 2014 [42337][-none-][INFO] Query Execution Time:0.0002448558807373
Sat Mar  1 19:58:21 2014 [42337][1][DEBUG] get_user_array query: SELECT id, first_name, last_name, user_name from users WHERE 1=1 ORDER BY user_name ASC
Sat Mar  1 19:58:21 2014 [42337][1][INFO] Query:SELECT id, first_name, last_name, user_name from users WHERE 1=1 ORDER BY user_name ASC
Sat Mar  1 19:58:21 2014 [42337][1][INFO] Query Execution Time:0.00016593933105469
Sat Mar  1 19:58:21 2014 [42337][1][INFO] Query:SELECT u1.first_name, u1.last_name from users  u1, users  u2 where u1.id = u2.reports_to_id AND u2.id = '1' and u1.deleted=0
Sat Mar  1 19:58:21 2014 [42337][1][INFO] Query Execution Time:0.00015091896057129
Sat Mar  1 19:58:21 2014 [42337][1][DEBUG] SugarBean[User].load_relationships, Loading relationship (reports_to_link).
Sat Mar  1 19:58:21 2014 [42337][1][INFO] Query:SELECT ea.email_address, ea.email_address_caps, ea.invalid_email, ea.opt_out, ea.date_created, ea.date_modified,
                ear.id, ear.email_address_id, ear.bean_id, ear.bean_module, ear.primary_address, ear.reply_to_address, ear.deleted
                FROM email_addresses ea LEFT JOIN email_addr_bean_rel ear ON ea.id = ear.email_address_id
                WHERE ear.bean_module = 'Users'
                AND ear.bean_id = '1'
                AND ear.deleted = 0
                ORDER BY ear.reply_to_address, ear.primary_address DESC
Sat Mar  1 19:58:21 2014 [42337][1][INFO] Query Execution Time:0.00035881996154785
Sat Mar  1 19:58:21 2014 [42337][1][DEBUG] Hook called: Users::after_retrieve
Sat Mar  1 19:58:21 2014 [42337][1][DEBUG] Current user is: admin
Sat Mar  1 19:58:21 2014 [42337][1][DEBUG] Current user is: admin
Sat Mar  1 19:58:21 2014 [42337][1][DEBUG] setting cookie ck_login_id_20 to 1
Sat Mar  1 19:58:21 2014 [42337][1][DEBUG] setting cookie ck_login_language_20 to en_us
Sat Mar  1 19:58:21 2014 [42337][1][DEBUG] current_language is: en_us
Sat Mar  1 19:58:21 2014 [42337][1][INFO] Found language file: en_us.lang.php
Sat Mar  1 19:58:21 2014 [42337][1][INFO] Query:SELECT count(*) as the_count FROM config WHERE category='info' AND name='sugar_version' AND value = '6.5.15'
Sat Mar  1 19:58:21 2014 [42337][1][INFO] Query Execution Time:0.00020503997802734
Sat Mar  1 19:58:21 2014 [42337][1][INFO] Query:SELECT category, name, value FROM config WHERE category = 'license'
Sat Mar  1 19:58:21 2014 [42337][1][INFO] Query Execution Time:0.00014710426330566
Sat Mar  1 19:58:21 2014 [42337][1][INFO] Query:SELECT id FROM outbound_email WHERE type = 'system'
Sat Mar  1 19:58:21 2014 [42337][1][INFO] Query Execution Time:9.7990036010742E-5
Sat Mar  1 19:58:21 2014 [42337][1][INFO] Query:SELECT * FROM outbound_email WHERE id = '94a6de96-23ab-1203-3647-530f41d556ac'
Sat Mar  1 19:58:21 2014 [42337][1][INFO] Query Execution Time:0.00011706352233887
Sat Mar  1 19:58:21 2014 [42337][1][DEBUG] Performing action: action_saveconfig MODULE: Configurator

I am at a loss on what is going on here...  The directories are all good...the file shows up under upload directory... but it appears nothing happens after their...and max debugging turn on and nothing shows up in the log either...

Anyone have any clues what or were I should be looking to get this installed... ?????

Thanks!!!
Parents
  • Lol...love your response... Guess you did not look at my posting... it is the max logging that sugar can do.  I have set the entire sugar directory to 777 just to make sure it was not a permission problem... but when you have a real answer or some kind of a clue on what is causing this I would love to hear it.

    Thanks bana!
  • I have been doing unix for over 25+ years.  I am very good at SQL and Systems.  Everything that is easy and everything that is able to turn debug on I have at max levels to figure out what is going on.  This is a new install of SugarCRM 6.5.15 and I did the upgrade to 6.5.16 figuring that would fix the problem after I have zero success of loading a module.

    This is using lighttpd / php / percona sql 5.6.  Those packages are working perfectly on FreeBSD 10.  It is showing all the missing png files and small code problems in sugarcrm in the log files.  Their are no indications of why the module loader is not working.  Last night I was able to get a different error that I followed out and that did not have any success with fixing the problem either.  It was dealing with zip and remove directories.  The upgrade module works fine.  So why the plugin module will not work and will not show any kind of error in the logs I have no clue on were to look.  Next step is go into sugar code and start logging to a file each function, but that will take way more time than this is worth.  I know sugar can not have this kinds of problems.  Too many people use it.  So their has to be variable that is not set and need to be set.  Is my guess on why the module loader for plugin will not work.

    The problem still remains after upload a plugin to sugar, it goes to a white page with just the 2 line that is always their at the top for the menu selections then blank middle and the bottom showing sql time.

    Anyways, if anyone has a clue or idea I would very much like to hear your comments.  I do not know were to look. 



Reply
  • I have been doing unix for over 25+ years.  I am very good at SQL and Systems.  Everything that is easy and everything that is able to turn debug on I have at max levels to figure out what is going on.  This is a new install of SugarCRM 6.5.15 and I did the upgrade to 6.5.16 figuring that would fix the problem after I have zero success of loading a module.

    This is using lighttpd / php / percona sql 5.6.  Those packages are working perfectly on FreeBSD 10.  It is showing all the missing png files and small code problems in sugarcrm in the log files.  Their are no indications of why the module loader is not working.  Last night I was able to get a different error that I followed out and that did not have any success with fixing the problem either.  It was dealing with zip and remove directories.  The upgrade module works fine.  So why the plugin module will not work and will not show any kind of error in the logs I have no clue on were to look.  Next step is go into sugar code and start logging to a file each function, but that will take way more time than this is worth.  I know sugar can not have this kinds of problems.  Too many people use it.  So their has to be variable that is not set and need to be set.  Is my guess on why the module loader for plugin will not work.

    The problem still remains after upload a plugin to sugar, it goes to a white page with just the 2 line that is always their at the top for the menu selections then blank middle and the bottom showing sql time.

    Anyways, if anyone has a clue or idea I would very much like to hear your comments.  I do not know were to look. 



Children
No Data