EasyApache4 provision process exited with errors

vacancy

Well-Known Member
Sep 20, 2012
566
226
93
Turkey
cPanel Access Level
Root Administrator
Hello

I've seen the following error when I didn't select php-fpm packages when compiling easyapache 4.


Code:
[2019-02-22 00:53:39 +0300] info [xml-api] apache_php_fpm restarted successfully.
[2019-02-22 00:53:39 +0300] info [xml-api] update() requires at least one user to update at /usr/local/cpanel/Cpanel/Config/userdata/UpdateCache.pm line 92.
[2019-02-22 00:53:39 +0300] info [xml-api]     Cpanel::Config::userdata::UpdateCache::update() called at /usr/local/cpanel/Cpanel/PHP/Vhosts.pm line 107
[2019-02-22 00:53:39 +0300] info [xml-api]     Cpanel::PHP::Vhosts::setup_vhosts_for_php(ARRAY(0x2cab120)) called at /usr/local/cpanel/Cpanel/PHPFPM.pm line 829
[2019-02-22 00:53:39 +0300] info [xml-api]     Cpanel::PHPFPM::_update_htaccess(HASH(0x239f688)) called at /usr/local/cpanel/Cpanel/PHPFPM.pm line 913
[2019-02-22 00:53:39 +0300] info [xml-api]     Cpanel::PHPFPM::rebuild_files(HASH(0x239f688), 0, 1, 1) called at /etc/yum/universal-hooks/multi_pkgs/posttrans/ea-php__WILDCARD__-php-fpm/100-phpfpm_cleanup.pl line 103
[2019-02-22 00:53:39 +0300] info [xml-api] [Fri Feb 22 00:53:14 2019] [100-phpfpm_cleanup] Cleaning up PHP-FPM configs for version 71 since we are removing the package.
[2019-02-22 00:53:39 +0300] info [xml-api] !!!! "/etc/yum/universal-hooks/multi_pkgs/posttrans/ea-php__WILDCARD__-php-fpm/100-phpfpm_cleanup.pl --pkg_list=/root/tmp/tmpMQP6V5" did not exit cleanly: 256
 

cPanelLauren

Product Owner II
Staff member
Nov 14, 2017
13,266
1,304
363
Houston
Hi @vacancy

I was able to replicate the output on a new server but I don't actually think it's an issue:

Code:
[2019-02-22 15:53:41 -0600] info [xml-api] Service Status
[2019-02-22 15:53:41 -0600] info [xml-api] apache_php_fpm restarted successfully.
[2019-02-22 15:53:41 -0600] info [xml-api] update() requires at least one user to update at /usr/local/cpanel/Cpanel/Config/userdata/UpdateCache.pm line 92.
[2019-02-22 15:53:41 -0600] info [xml-api]     Cpanel::Config::userdata::UpdateCache::update() called at /usr/local/cpanel/Cpanel/PHP/Vhosts.pm line 107
[2019-02-22 15:53:41 -0600] info [xml-api]     Cpanel::PHP::Vhosts::setup_vhosts_for_php(ARRAY(0x1f63298)) called at /usr/local/cpanel/Cpanel/PHPFPM.pm line 829
[2019-02-22 15:53:41 -0600] info [xml-api]     Cpanel::PHPFPM::_update_htaccess(HASH(0x15da7c8)) called at /usr/local/cpanel/Cpanel/PHPFPM.pm line 913
[2019-02-22 15:53:41 -0600] info [xml-api]     Cpanel::PHPFPM::rebuild_files(HASH(0x15da7c8), 0, 1, 1) called at /etc/yum/universal-hooks/multi_pkgs/posttrans/ea-php__WILDCARD__-php-fpm/100-phpfpm_cleanup.pl line 103
[2019-02-22 15:53:41 -0600] info [xml-api] [Fri Feb 22 15:53:41 2019] [100-phpfpm_cleanup] Cleaning up PHP-FPM configs for version 71 since we are removing the package.
[2019-02-22 15:53:41 -0600] info [xml-api]
Since there is no user's using php-fpm when it's not installed or it's uninstalled the API goes through and tries to clean up the configuration files or calls to php-fpm and finds none and gives this output. The next output shows it successfully removed:

Code:
[2019-02-22 15:53:41 -0600] info [xml-api] [Fri Feb 22 15:53:41 2019] [100-phpfpm_cleanup] Cleaning up PHP-FPM configs for version 71 since we are removing the package.
[2019-02-22 15:53:41 -0600] info [xml-api] 
[2019-02-22 15:53:41 -0600] info [xml-api] !!!! "/etc/yum/universal-hooks/multi_pkgs/posttrans/ea-php__WILDCARD__-php-fpm/100-phpfpm_cleanup.pl --pkg_list=/root/tmp/tmpgqDHT6" did not exit cleanly: 256
[2019-02-22 15:53:41 -0600] info [xml-api]   Verifying  : ea-php71-php-fpm-7.1.26-2.2.5.cpanel.x86_64                  1/4
[2019-02-22 15:53:41 -0600] info [xml-api]   Verifying  : ea-apache24-mod_proxy_fcgi-2.4.38-1.1.4.cpanel.x86_64        2/4
[2019-02-22 15:53:41 -0600] info [xml-api]   Verifying  : ea-php70-php-fpm-7.0.33-2.2.5.cpanel.x86_64                  3/4
[2019-02-22 15:53:41 -0600] info [xml-api]   Verifying  : ea-php56-php-fpm-5.6.40-2.2.5.cpanel.x86_64                  4/4
[2019-02-22 15:53:41 -0600] info [xml-api] Removed:
[2019-02-22 15:53:41 -0600] info [xml-api]   ea-apache24-mod_proxy_fcgi.x86_64 0:2.4.38-1.1.4.cpanel                       
[2019-02-22 15:53:41 -0600] info [xml-api]   ea-php56-php-fpm.x86_64 0:5.6.40-2.2.5.cpanel                                 
[2019-02-22 15:53:41 -0600] info [xml-api]   ea-php70-php-fpm.x86_64 0:7.0.33-2.2.5.cpanel                                 
[2019-02-22 15:53:41 -0600] info [xml-api]   ea-php71-php-fpm.x86_64 0:7.1.26-2.2.5.cpanel                                 
[2019-02-22 15:53:41 -0600] info [xml-api] Finished Transaction
[2019-02-22 15:53:41 -0600] info [xml-api] Leaving Shell

Provision process finished.
 
  • Like
Reactions: vacancy

vacancy

Well-Known Member
Sep 20, 2012
566
226
93
Turkey
cPanel Access Level
Root Administrator
Hi

I have seen a different error in mod_lsapi installation.

Code:
[2019-02-23 17:34:53 +0300] info [xml-api]   Installing : ea-apache24-mod_lsapi-1.1-35.35.5.cpanel.x86_64           52/194
[2019-02-23 17:34:53 +0300] info [xml-api] AH00534: httpd: Configuration error: More than one MPM loaded.
[2019-02-23 17:34:53 +0300] info [xml-api] AH00534: httpd: Configuration error: More than one MPM loaded.
[2019-02-23 17:34:53 +0300] info [xml-api] Cpanel::Exception::MissingParameter/(XID yx5c2j) Provide the ?type? parameter for the ?Cpanel::WebServer::Supported::apache::make_handler? function.
[2019-02-23 17:34:53 +0300] info [xml-api]  at /usr/local/cpanel/Cpanel/WebServer/Supported/apache.pm line 222.
[2019-02-23 17:34:53 +0300] info [xml-api]     Cpanel::WebServer::Supported::apache::make_handler(Cpanel::WebServer::Supported::apache=HASH(0x147bf88), "lang", Cpanel::ProgLang::Supported::php=HASH(0x1519e48), "package", "ea-php54", "type", undef) called at /usr/local/cpanel/bin/rebuild_phpconf line 192
[2019-02-23 17:34:53 +0300] info [xml-api]     bin::rebuild_phpconf::ea4::do_current(HASH(0xe83a30), Cpanel::ProgLang::Supported::php=HASH(0x1519e48), Cpanel::WebServer::Supported::apache=HASH(0x147bf88)) called at /usr/local/cpanel/bin/rebuild_phpconf line 224
[2019-02-23 17:34:53 +0300] info [xml-api]     bin::rebuild_phpconf::ea4::run(ARRAY(0x894a08)) called at /usr/local/cpanel/bin/rebuild_phpconf line 401
[2019-02-23 17:34:53 +0300] info [xml-api] Cpanel::Exception::MissingParameter/(XID w8njv9) Provide the ?type? parameter for the ?Cpanel::WebServer::Supported::apache::make_handler? function.
[2019-02-23 17:34:53 +0300] info [xml-api]  at /usr/local/cpanel/Cpanel/WebServer/Supported/apache.pm line 222.
[2019-02-23 17:34:53 +0300] info [xml-api]     Cpanel::WebServer::Supported::apache::make_handler(Cpanel::WebServer::Supported::apache=HASH(0x1c91ec0), "lang", Cpanel::ProgLang::Supported::php=HASH(0x1d2fdf8), "package", "ea-php54", "type", undef) called at /usr/local/cpanel/bin/rebuild_phpconf line 192
[2019-02-23 17:34:53 +0300] info [xml-api]     bin::rebuild_phpconf::ea4::do_current(HASH(0x1699a10), Cpanel::ProgLang::Supported::php=HASH(0x1d2fdf8), Cpanel::WebServer::Supported::apache=HASH(0x1c91ec0)) called at /usr/local/cpanel/bin/rebuild_phpconf line 224
[2019-02-23 17:34:53 +0300] info [xml-api]     bin::rebuild_phpconf::ea4::run(ARRAY(0x10aaa08)) called at /usr/local/cpanel/bin/rebuild_phpconf line 401
[2019-02-23 17:34:53 +0300] info [xml-api] Initial configuration generation failed with the following message:
[2019-02-23 17:34:53 +0300] info [xml-api] The ?/usr/sbin/httpd -DSSL -t -f /etc/apache2/conf/httpd.conf.work.6aac254b.cfgcheck -C Include "/etc/apache2/conf.modules.d/*.conf"? command (process 14563) reported error number 1 when it ended.
[2019-02-23 17:34:53 +0300] info [xml-api] AH00534: httpd: Configuration error: More than one MPM loaded.
[2019-02-23 17:34:53 +0300] info [xml-api] Rebuilding configuration without any local modifications.
[2019-02-23 17:34:53 +0300] info [xml-api] Failed to generate a syntactically correct Apache configuration.
[2019-02-23 17:34:53 +0300] info [xml-api] Bad configuration file located at /etc/apache2/conf/httpd.conf.work.6aac254b
[2019-02-23 17:34:53 +0300] info [xml-api] Error:
[2019-02-23 17:34:53 +0300] info [xml-api] The ?/usr/sbin/httpd -DSSL -t -f /etc/apache2/conf/httpd.conf.work.6aac254b.cfgcheck -C Include "/etc/apache2/conf.modules.d/*.conf"? command (process 14564) reported error number 1 when it ended.
[2019-02-23 17:34:53 +0300] info [xml-api] AH00534: httpd: Configuration error: More than one MPM loaded.
[2019-02-23 17:34:53 +0300] info [xml-api] Reconfiguration completed
 

cPanelLauren

Product Owner II
Staff member
Nov 14, 2017
13,266
1,304
363
Houston
HI @vacancy

I believe this is a bit different than the initial issue. Can you please run the following and let me know the output?


Code:
 /usr/local/cpanel/bin/rebuild_phpconf --current
/usr/local/cpanel/bin/rebuild_phpconf --available
Code:
httpd -M |grep mpm
 mpm_prefork_module (shared)
 

vacancy

Well-Known Member
Sep 20, 2012
566
226
93
Turkey
cPanel Access Level
Root Administrator
Outputs before choosing lsapi handler.

There is no problem when lsapi handler is selected.

Code:
[root@server ~]#  /usr/local/cpanel/bin/rebuild_phpconf --current
DEFAULT PHP: ea-php56
ea-php54 SAPI: suphp
ea-php55 SAPI: suphp
ea-php56 SAPI: suphp
ea-php70 SAPI: suphp
ea-php71 SAPI: suphp
ea-php72 SAPI: suphp
Code:
[root@server ~]# /usr/local/cpanel/bin/rebuild_phpconf --available
ea-php54: cgi lsapi none suphp
ea-php55: cgi lsapi none suphp
ea-php56: cgi lsapi none suphp
ea-php70: cgi lsapi none suphp
ea-php71: cgi lsapi none suphp
ea-php72: cgi lsapi none suphp
Code:
[root@server ~]# httpd -M |grep mpm
 mpm_event_module (shared)
 

cPanelLauren

Product Owner II
Staff member
Nov 14, 2017
13,266
1,304
363
Houston
HI @vacancy

Are you able to start apache successfully as well as use lsapi as the handler when doing so? There was previously an issue with ea-apache24-mod_lsapi-1.1-36.el7.cloudlinux.x86_64 though this isn't the version you're running and it was only on CloudLinux servers.
 

cPanelLauren

Product Owner II
Staff member
Nov 14, 2017
13,266
1,304
363
Houston
Hi @vacancy

I agree, if you reprovision using easyapache do you get the same error? It's hard to tell you if there's an issue if it's not able to be replicated.

Also what happens when you run the following:

Code:
mv /etc/apache2/conf/httpd.conf{,.bk}
/scripts/rebuildhttpdconf
/scripts/restartsrv_httpd

Thanks!
 

vacancy

Well-Known Member
Sep 20, 2012
566
226
93
Turkey
cPanel Access Level
Root Administrator
There is no error when I do provision for the second time.

Code:
[root@vultr ~]# /scripts/rebuildhttpdconf
Built /etc/apache2/conf/httpd.conf OK
Code:
[root@vultr ~]# /scripts/restartsrv_httpd
Waiting for “httpd” to restart gracefully …waiting for “httpd” to initialize ………finished.

Service Status
        httpd (/usr/sbin/httpd -k start) is running as root with PID 15237 (systemd+/proc check method).
        httpd (/usr/local/cpanel/bin/splitlogs --dir=/etc/apache2/logs/domlogs --main=server.sop.com --suffix=-bytes_log) is running as root with PID 15238 (systemd+/proc check method).
        httpd (/usr/local/cpanel/bin/splitlogs --dir=/etc/apache2/logs/domlogs --main=server.sop.com --mainout=/etc/apache2/logs/access_log) is running as root with PID 15239 (systemd+/proc check method).

Startup Log
        Feb 25 23:01:15 vultr.guest systemd[1]: Starting Apache web server managed by cPanel EasyApache...
        Feb 25 23:01:15 vultr.guest systemd[1]: PID file /run/apache2/httpd.pid not readable (yet?) after start.
        Feb 25 23:01:15 vultr.guest systemd[1]: Started Apache web server managed by cPanel EasyApache.

Log Messages
        [Mon Feb 25 23:01:15.420234 2019] [mpm_event:notice] [pid 15237:tid 47963493688384] AH00489: Apache/2.4.38 (cPanel) OpenSSL/1.0.2q mod_bwlimited/1.4 configured -- resuming normal operations
        [Mon Feb 25 23:01:15.386646 2019] [:notice] [pid 15234:tid 47963493688384] ModSecurity for Apache/2.9.2 (http://www.modsecurity.org/) configured.
        [Mon Feb 25 22:58:50.461678 2019] [mpm_prefork:notice] [pid 5450] AH00163: Apache/2.4.38 (cPanel) OpenSSL/1.0.2q mod_bwlimited/1.4 configured -- resuming normal operations
        [Mon Feb 25 22:57:58.301352 2019] [mpm_prefork:notice] [pid 5450] AH00163: Apache/2.4.38 (cPanel) OpenSSL/1.0.2q mod_bwlimited/1.4 configured -- resuming normal operations
        [Mon Feb 25 22:57:58.277451 2019] [:notice] [pid 5232] ModSecurity for Apache/2.9.2 (http://www.modsecurity.org/) configured.
        [Mon Feb 25 22:56:36.006004 2019] [mpm_prefork:notice] [pid 19897] AH00163: Apache/2.4.38 (cPanel) OpenSSL/1.0.2q mod_bwlimited/1.4 configured -- resuming normal operations
        [Mon Feb 25 22:55:10.321788 2019] [mpm_prefork:notice] [pid 19897] AH00163: Apache/2.4.38 (cPanel) OpenSSL/1.0.2q mod_bwlimited/1.4 configured -- resuming normal operations
        [Mon Feb 25 22:54:47.185950 2019] [mpm_prefork:notice] [pid 19897] AH00163: Apache/2.4.38 (cPanel) OpenSSL/1.0.2q mod_bwlimited/1.4 configured -- resuming normal operations
        [Mon Feb 25 22:54:30.530695 2019] [mpm_prefork:notice] [pid 19897] AH00163: Apache/2.4.38 (cPanel) OpenSSL/1.0.2q mod_bwlimited/1.4 configured -- resuming normal operations
        [Mon Feb 25 22:54:30.504643 2019] [:notice] [pid 19894] ModSecurity for Apache/2.9.2 (http://www.modsecurity.org/) configured.
        [Mon Feb 25 22:54:20.604228 2019] [mpm_prefork:notice] [pid 19548] AH00163: Apache/2.4.38 (cPanel) OpenSSL/1.0.2q mod_bwlimited/1.4 configured -- resuming normal operations
        [Mon Feb 25 22:54:20.581049 2019] [:notice] [pid 19543] ModSecurity for Apache/2.9.2 (http://www.modsecurity.org/) configured.
        [Mon Feb 25 22:53:36.596603 2019] [mpm_prefork:notice] [pid 18837] AH00163: Apache/2.4.38 (cPanel) OpenSSL/1.0.2q mod_bwlimited/1.4 configured -- resuming normal operations
        [Mon Feb 25 22:53:36.576811 2019] [:notice] [pid 18836] ModSecurity for Apache/2.9.2 (http://www.modsecurity.org/) configured.

httpd restarted successfully.